builder: mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s slave: talos-linux64-ix-040 starttime: 1495476327.09 results: success (0) revision: f9ca97a334296facd2e0ea5582e7f12d0fe70fe4 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.086203) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.086728) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.086993) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.114866) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.115229) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-22 11:05:27-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 110M=0s 2017-05-22 11:05:27 (110 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.087393 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.214870) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.215142) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019789 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.263734) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:27.264030) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev f9ca97a334296facd2e0ea5582e7f12d0fe70fe4 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev f9ca97a334296facd2e0ea5582e7f12d0fe70fe4 --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=9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-22 11:05:27,392 truncating revision to first 12 chars 2017-05-22 11:05:27,392 Setting DEBUG logging. 2017-05-22 11:05:27,392 attempt 1/10 2017-05-22 11:05:27,392 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/f9ca97a33429?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-22 11:05:27,930 unpacking tar archive at: mozilla-central-f9ca97a33429/testing/mozharness/ program finished with exit code 0 elapsedTime=0.846997 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:28.123352) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:28.123705) ========= script_repo_revision: f9ca97a334296facd2e0ea5582e7f12d0fe70fe4 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:28.124132) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:28.124433) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-22 11:05:28.132364) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2017-05-22 11:05:28.132646) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:05:28 INFO - MultiFileLogger online at 20170522 11:05:28 in /builds/slave/test 11:05:28 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 11:05:28 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:05:28 INFO - {'append_to_log': False, 11:05:28 INFO - 'base_work_dir': '/builds/slave/test', 11:05:28 INFO - 'blob_upload_branch': 'Firefox', 11:05:28 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:05:28 INFO - 'branch': 'Firefox', 11:05:28 INFO - 'buildbot_json_path': 'buildprops.json', 11:05:28 INFO - 'config_files': ('talos/linux_config.py',), 11:05:28 INFO - 'default_actions': ('clobber', 11:05:28 INFO - 'read-buildbot-config', 11:05:28 INFO - 'download-and-extract', 11:05:28 INFO - 'populate-webroot', 11:05:28 INFO - 'create-virtualenv', 11:05:28 INFO - 'install', 11:05:28 INFO - 'run-tests'), 11:05:28 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:05:28 INFO - 'download_minidump_stackwalk': True, 11:05:28 INFO - 'download_symbols': 'ondemand', 11:05:28 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:05:28 INFO - 'tooltool.py': '/tools/tooltool.py', 11:05:28 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:05:28 INFO - '/tools/misc-python/virtualenv.py')}, 11:05:28 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:05:28 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:05:28 INFO - 'gecko_profile': False, 11:05:28 INFO - 'gecko_profile_interval': 0, 11:05:28 INFO - 'installer_path': 'installer.exe', 11:05:28 INFO - 'log_level': 'info', 11:05:28 INFO - 'log_name': 'talos', 11:05:28 INFO - 'log_to_console': True, 11:05:28 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:05:28 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:05:28 INFO - 'opt_config_files': (), 11:05:28 INFO - 'pip_index': False, 11:05:28 INFO - 'suite': 'dromaeojs-e10s', 11:05:28 INFO - 'system_bits': '32', 11:05:28 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:05:28 INFO - 'title': 'talos-linux64-ix-040', 11:05:28 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:05:28 INFO - 'use_talos_json': True, 11:05:28 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:05:28 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:05:28 INFO - 'work_dir': 'build'} 11:05:28 INFO - [mozharness: 2017-05-22 18:05:28.360096Z] Running clobber step. 11:05:28 INFO - Running pre-action listener: _resource_record_pre_action 11:05:28 INFO - Running main action method: clobber 11:05:28 INFO - rmtree: /builds/slave/test/build 11:05:28 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:05:29 INFO - Running post-action listener: _resource_record_post_action 11:05:29 INFO - [mozharness: 2017-05-22 18:05:29.374605Z] Finished clobber step (success) 11:05:29 INFO - [mozharness: 2017-05-22 18:05:29.374708Z] Running read-buildbot-config step. 11:05:29 INFO - Running pre-action listener: _resource_record_pre_action 11:05:29 INFO - Running main action method: read_buildbot_config 11:05:29 INFO - Using buildbot properties: 11:05:29 INFO - { 11:05:29 INFO - "project": "", 11:05:29 INFO - "product": "firefox", 11:05:29 INFO - "who": "archaeopteryx@coole-files.de", 11:05:29 INFO - "installer_path": "public/build/target.tar.bz2", 11:05:29 INFO - "builddir": "mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s", 11:05:29 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 11:05:29 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo-sequential mozilla-central talos dromaeojs-e10s", 11:05:29 INFO - "stage_platform": "linux64-stylosequential", 11:05:29 INFO - "basedir": "/builds/slave/test", 11:05:29 INFO - "buildnumber": 9, 11:05:29 INFO - "platform": "ubuntu64_hw_styloseq", 11:05:29 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 11:05:29 INFO - "slavebuilddir": "test", 11:05:29 INFO - "taskId": "UwOqORvARj2gE1zASKONpA", 11:05:29 INFO - "branch": "mozilla-central", 11:05:29 INFO - "script_repo_revision": "production", 11:05:29 INFO - "revision": "f9ca97a334296facd2e0ea5582e7f12d0fe70fe4", 11:05:29 INFO - "slavename": "talos-linux64-ix-040", 11:05:29 INFO - "repo_path": "mozilla-central" 11:05:29 INFO - } 11:05:29 INFO - Finding installer, test and symbols from parent task. 11:05:29 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/UwOqORvARj2gE1zASKONpA'}, attempt #1 11:05:29 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/UwOqORvARj2gE1zASKONpA'}, attempt #1 11:05:30 INFO - Task dependencies: EC69cXx2Tm6yTBE0GLEc_g 11:05:30 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g'}, attempt #1 11:05:30 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.tar.bz2 11:05:30 INFO - Set test_url: https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/test_packages.json 11:05:30 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.crashreporter-symbols.zip 11:05:30 INFO - Running post-action listener: _resource_record_post_action 11:05:30 INFO - [mozharness: 2017-05-22 18:05:30.767748Z] Finished read-buildbot-config step (success) 11:05:30 INFO - [mozharness: 2017-05-22 18:05:30.767969Z] Running download-and-extract step. 11:05:30 INFO - Running pre-action listener: _resource_record_pre_action 11:05:30 INFO - Running main action method: download_and_extract 11:05:30 INFO - mkdir: /builds/slave/test/build/tests 11:05:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:05:30 INFO - trying https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.test_packages.json 11:05:30 INFO - Downloading https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 11:05:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 11:05:31 INFO - Downloaded 986 bytes. 11:05:31 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 11:05:31 INFO - Using the following test package requirements: 11:05:31 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 11:05:31 INFO - u'common': [u'target.common.tests.zip'], 11:05:31 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 11:05:31 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 11:05:31 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 11:05:31 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 11:05:31 INFO - u'mozbase': [u'target.common.tests.zip'], 11:05:31 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 11:05:31 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 11:05:31 INFO - u'web-platform': [u'target.common.tests.zip', 11:05:31 INFO - u'target.web-platform.tests.zip'], 11:05:31 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 11:05:31 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 11:05:31 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.common.tests.zip 11:05:31 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.common.tests.zip'}, attempt #1 11:05:31 INFO - Fetch https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.common.tests.zip into memory 11:05:33 INFO - Content-Length response header: 63520780 11:05:33 INFO - Bytes received: 63520780 11:05:44 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 11:05:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.common.tests.zip 11:05:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.common.tests.zip'}, attempt #1 11:05:44 INFO - Fetch https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.common.tests.zip into memory 11:05:45 INFO - Content-Length response header: 63520780 11:05:45 INFO - Bytes received: 63520780 11:05:57 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.talos.tests.zip 11:05:57 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.talos.tests.zip'}, attempt #1 11:05:57 INFO - Fetch https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.talos.tests.zip into memory 11:05:58 INFO - Content-Length response header: 14410000 11:05:58 INFO - Bytes received: 14410000 11:05:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:05:58 INFO - trying https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.tar.bz2 11:05:58 INFO - Downloading https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 11:05:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 11:06:00 INFO - Downloaded 56432983 bytes. 11:06:00 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.tar.bz2 11:06:00 INFO - mkdir: /builds/slave/test/properties 11:06:00 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:06:00 INFO - Writing to file /builds/slave/test/properties/build_url 11:06:00 INFO - Contents: 11:06:00 INFO - build_url:https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.tar.bz2 11:06:00 INFO - Running post-action listener: _resource_record_post_action 11:06:00 INFO - Running post-action listener: set_extra_try_arguments 11:06:00 INFO - [mozharness: 2017-05-22 18:06:00.678205Z] Finished download-and-extract step (success) 11:06:00 INFO - [mozharness: 2017-05-22 18:06:00.678393Z] Running populate-webroot step. 11:06:00 INFO - Running pre-action listener: _resource_record_pre_action 11:06:00 INFO - Running main action method: populate_webroot 11:06:00 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:06:00 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:06:00 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:06:00 INFO - '--tppagecycles', 11:06:00 INFO - '7'], 11:06:00 INFO - 'tests': ['tsvgm']}}, 11:06:00 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:06:00 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:06:00 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:06:00 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:06:00 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 11:06:00 INFO - 'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:06:00 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 11:06:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:06:00 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 11:06:00 INFO - 'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['damp', 'tps']}, 11:06:00 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 11:06:00 INFO - 'tests': ['damp', 'tps']}, 11:06:00 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['dromaeo_dom']}, 11:06:00 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:06:00 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 11:06:00 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 11:06:00 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 11:06:00 INFO - 'tests': ['ts_paint', 'tp5o']}, 11:06:00 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['a11yr', 11:06:00 INFO - 'ts_paint', 11:06:00 INFO - 'tpaint', 11:06:00 INFO - 'sessionrestore', 11:06:00 INFO - 'sessionrestore_no_auto_restore', 11:06:00 INFO - 'tabpaint']}, 11:06:00 INFO - 'other-e10s': {'tests': ['a11yr', 11:06:00 INFO - 'ts_paint', 11:06:00 INFO - 'tpaint', 11:06:00 INFO - 'sessionrestore', 11:06:00 INFO - 'sessionrestore_no_auto_restore', 11:06:00 INFO - 'tabpaint']}, 11:06:00 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:06:00 INFO - 'ts_paint', 11:06:00 INFO - 'tpaint', 11:06:00 INFO - 'sessionrestore', 11:06:00 INFO - 'sessionrestore_no_auto_restore', 11:06:00 INFO - 'tabpaint']}, 11:06:00 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:06:00 INFO - 'ts_paint', 11:06:00 INFO - 'tpaint', 11:06:00 INFO - 'sessionrestore', 11:06:00 INFO - 'sessionrestore_no_auto_restore', 11:06:00 INFO - 'tabpaint']}, 11:06:00 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['a11yr', 11:06:00 INFO - 'ts_paint', 11:06:00 INFO - 'tpaint', 11:06:00 INFO - 'sessionrestore', 11:06:00 INFO - 'sessionrestore_no_auto_restore', 11:06:00 INFO - 'tabpaint']}, 11:06:00 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['a11yr', 11:06:00 INFO - 'ts_paint', 11:06:00 INFO - 'tpaint', 11:06:00 INFO - 'sessionrestore', 11:06:00 INFO - 'sessionrestore_no_auto_restore', 11:06:00 INFO - 'tabpaint']}, 11:06:00 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 11:06:00 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 11:06:00 INFO - 'bloom_basic_ref']}, 11:06:00 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['tsvgx', 11:06:00 INFO - 'tsvgr_opacity', 11:06:00 INFO - 'tart', 11:06:00 INFO - 'tscrollx', 11:06:00 INFO - 'cart', 11:06:00 INFO - 'tsvg_static']}, 11:06:00 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:06:00 INFO - 'tsvgr_opacity', 11:06:00 INFO - 'tart', 11:06:00 INFO - 'tscrollx', 11:06:00 INFO - 'cart', 11:06:00 INFO - 'tsvg_static']}, 11:06:00 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 11:06:00 INFO - 'talos_options': ['--disable-e10s'], 11:06:00 INFO - 'tests': ['tp5o']}, 11:06:00 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 11:06:00 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 11:06:00 INFO - 'talos_options': ['--disable-e10s', 11:06:00 INFO - '--xperf_path', 11:06:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:06:00 INFO - 'tests': ['tp5n']}, 11:06:00 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 11:06:00 INFO - 'talos_options': ['--xperf_path', 11:06:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:06:00 INFO - 'tests': ['tp5n']}}, 11:06:00 INFO - 'talos.zip': {'path': '', 11:06:00 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:06:00 INFO - Running post-action listener: _resource_record_post_action 11:06:00 INFO - [mozharness: 2017-05-22 18:06:00.700197Z] Finished populate-webroot step (success) 11:06:00 INFO - [mozharness: 2017-05-22 18:06:00.700285Z] Running create-virtualenv step. 11:06:00 INFO - Running pre-action listener: _resource_record_pre_action 11:06:00 INFO - Running main action method: create_virtualenv 11:06:00 INFO - Creating virtualenv /builds/slave/test/build/venv 11:06:00 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 11:06:00 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:06:00 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:06:00 INFO - Using real prefix '/usr' 11:06:00 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:06:01 INFO - Installing distribute.............................................................................................................................................................................................done. 11:06:03 INFO - Installing pip.................done. 11:06:03 INFO - Return code: 0 11:06:03 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 11:06:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 11:06:03 INFO - Reading from file tmpfile_stdout 11:06:03 INFO - Output received: 11:06:03 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 11:06:03 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:06:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:03 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/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:06:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 11:06:03 INFO - Using env: {'DISPLAY': ':0', 11:06:03 INFO - 'HOME': '/home/cltbld', 11:06:03 INFO - 'LANG': 'en_US.UTF-8', 11:06:03 INFO - 'LANGUAGE': 'en_US:en', 11:06:03 INFO - 'LOGNAME': 'cltbld', 11:06:03 INFO - 'MAIL': '/var/mail/cltbld', 11:06:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:03 INFO - 'MOZ_NO_REMOTE': '1', 11:06:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:03 INFO - 'NO_EM_RESTART': '1', 11:06:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:03 INFO - 'PWD': '/builds/slave/test', 11:06:03 INFO - 'SHELL': '/bin/bash', 11:06:03 INFO - 'SHLVL': '1', 11:06:03 INFO - 'TERM': 'linux', 11:06:03 INFO - 'TMOUT': '86400', 11:06:03 INFO - 'USER': 'cltbld', 11:06:03 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:03 INFO - '_': '/tools/buildbot/bin/python'} 11:06:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:03 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 11:06:03 INFO - Cleaning up... 11:06:03 INFO - Return code: 0 11:06:03 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:06:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:03 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/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:06:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 11:06:03 INFO - Using env: {'DISPLAY': ':0', 11:06:03 INFO - 'HOME': '/home/cltbld', 11:06:03 INFO - 'LANG': 'en_US.UTF-8', 11:06:03 INFO - 'LANGUAGE': 'en_US:en', 11:06:03 INFO - 'LOGNAME': 'cltbld', 11:06:03 INFO - 'MAIL': '/var/mail/cltbld', 11:06:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:03 INFO - 'MOZ_NO_REMOTE': '1', 11:06:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:03 INFO - 'NO_EM_RESTART': '1', 11:06:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:03 INFO - 'PWD': '/builds/slave/test', 11:06:03 INFO - 'SHELL': '/bin/bash', 11:06:03 INFO - 'SHLVL': '1', 11:06:03 INFO - 'TERM': 'linux', 11:06:03 INFO - 'TMOUT': '86400', 11:06:03 INFO - 'USER': 'cltbld', 11:06:03 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:03 INFO - '_': '/tools/buildbot/bin/python'} 11:06:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:03 INFO - Downloading/unpacking psutil>=3.1.1 11:06:03 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 11:06:03 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 11:06:03 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 11:06:03 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 11:06:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:06:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:06:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:06:05 INFO - Installing collected packages: psutil 11:06:05 INFO - Running setup.py install for psutil 11:06:05 INFO - building 'psutil._psutil_linux' extension 11:06:05 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 11:06:05 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 11:06:05 INFO - building 'psutil._psutil_posix' extension 11:06:05 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 11:06:05 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 11:06:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:06:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:06:05 INFO - Successfully installed psutil 11:06:05 INFO - Cleaning up... 11:06:05 INFO - Return code: 0 11:06:05 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:06:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:05 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/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:06:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 11:06:05 INFO - Using env: {'DISPLAY': ':0', 11:06:05 INFO - 'HOME': '/home/cltbld', 11:06:05 INFO - 'LANG': 'en_US.UTF-8', 11:06:05 INFO - 'LANGUAGE': 'en_US:en', 11:06:05 INFO - 'LOGNAME': 'cltbld', 11:06:05 INFO - 'MAIL': '/var/mail/cltbld', 11:06:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:05 INFO - 'MOZ_NO_REMOTE': '1', 11:06:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:05 INFO - 'NO_EM_RESTART': '1', 11:06:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:05 INFO - 'PWD': '/builds/slave/test', 11:06:05 INFO - 'SHELL': '/bin/bash', 11:06:05 INFO - 'SHLVL': '1', 11:06:05 INFO - 'TERM': 'linux', 11:06:05 INFO - 'TMOUT': '86400', 11:06:05 INFO - 'USER': 'cltbld', 11:06:05 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:05 INFO - '_': '/tools/buildbot/bin/python'} 11:06:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:05 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:06: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 11:06: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 11:06: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 11:06: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 11:06:06 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:06:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:06:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:06:07 INFO - Installing collected packages: mozsystemmonitor 11:06:07 INFO - Running setup.py install for mozsystemmonitor 11:06:07 INFO - Successfully installed mozsystemmonitor 11:06:07 INFO - Cleaning up... 11:06:07 INFO - Return code: 0 11:06:07 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:06:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06: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/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:06:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 11:06:07 INFO - Using env: {'DISPLAY': ':0', 11:06:07 INFO - 'HOME': '/home/cltbld', 11:06:07 INFO - 'LANG': 'en_US.UTF-8', 11:06:07 INFO - 'LANGUAGE': 'en_US:en', 11:06:07 INFO - 'LOGNAME': 'cltbld', 11:06:07 INFO - 'MAIL': '/var/mail/cltbld', 11:06:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:07 INFO - 'MOZ_NO_REMOTE': '1', 11:06:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:07 INFO - 'NO_EM_RESTART': '1', 11:06:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:07 INFO - 'PWD': '/builds/slave/test', 11:06:07 INFO - 'SHELL': '/bin/bash', 11:06:07 INFO - 'SHLVL': '1', 11:06:07 INFO - 'TERM': 'linux', 11:06:07 INFO - 'TMOUT': '86400', 11:06:07 INFO - 'USER': 'cltbld', 11:06:07 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:07 INFO - '_': '/tools/buildbot/bin/python'} 11:06:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:07 INFO - Downloading/unpacking jsonschema==2.5.1 11:06: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 11:06: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 11:06: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 11:06: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 11:06:08 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:06:08 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:06:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:06:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:06:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:06:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:06:08 INFO - Downloading functools32-3.2.3-2.tar.gz 11:06:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:06:08 INFO - warning: no files found matching '*.txt' 11:06:08 INFO - no previously-included directories found matching 'build' 11:06:08 INFO - no previously-included directories found matching 'dist' 11:06:08 INFO - no previously-included directories found matching '.git*' 11:06:08 INFO - Installing collected packages: jsonschema, functools32 11:06:08 INFO - Running setup.py install for functools32 11:06:08 INFO - warning: no files found matching '*.txt' 11:06:08 INFO - no previously-included directories found matching 'build' 11:06:08 INFO - no previously-included directories found matching 'dist' 11:06:08 INFO - no previously-included directories found matching '.git*' 11:06:08 INFO - Successfully installed jsonschema functools32 11:06:08 INFO - Cleaning up... 11:06:08 INFO - Return code: 0 11:06:08 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 11:06:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:08 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 11:06:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 11:06:08 INFO - Using env: {'DISPLAY': ':0', 11:06:08 INFO - 'HOME': '/home/cltbld', 11:06:08 INFO - 'LANG': 'en_US.UTF-8', 11:06:08 INFO - 'LANGUAGE': 'en_US:en', 11:06:08 INFO - 'LOGNAME': 'cltbld', 11:06:08 INFO - 'MAIL': '/var/mail/cltbld', 11:06:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:08 INFO - 'MOZ_NO_REMOTE': '1', 11:06:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:08 INFO - 'NO_EM_RESTART': '1', 11:06:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:08 INFO - 'PWD': '/builds/slave/test', 11:06:08 INFO - 'SHELL': '/bin/bash', 11:06:08 INFO - 'SHLVL': '1', 11:06:08 INFO - 'TERM': 'linux', 11:06:08 INFO - 'TMOUT': '86400', 11:06:08 INFO - 'USER': 'cltbld', 11:06:08 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:08 INFO - '_': '/tools/buildbot/bin/python'} 11:06:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:09 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 11:06:09 INFO - Cleaning up... 11:06:09 INFO - Return code: 0 11:06:09 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:06:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 11:06:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 11:06:09 INFO - Using env: {'DISPLAY': ':0', 11:06:09 INFO - 'HOME': '/home/cltbld', 11:06:09 INFO - 'LANG': 'en_US.UTF-8', 11:06:09 INFO - 'LANGUAGE': 'en_US:en', 11:06:09 INFO - 'LOGNAME': 'cltbld', 11:06:09 INFO - 'MAIL': '/var/mail/cltbld', 11:06:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:09 INFO - 'MOZ_NO_REMOTE': '1', 11:06:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:09 INFO - 'NO_EM_RESTART': '1', 11:06:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:09 INFO - 'PWD': '/builds/slave/test', 11:06:09 INFO - 'SHELL': '/bin/bash', 11:06:09 INFO - 'SHLVL': '1', 11:06:09 INFO - 'TERM': 'linux', 11:06:09 INFO - 'TMOUT': '86400', 11:06:09 INFO - 'USER': 'cltbld', 11:06:09 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:09 INFO - '_': '/tools/buildbot/bin/python'} 11:06:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:09 INFO - Downloading/unpacking blobuploader==1.2.4 11:06:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:06:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:06:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:06:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:06:10 INFO - Downloading blobuploader-1.2.4.tar.gz 11:06:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:06:10 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:06: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 11:06: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 11:06: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 11:06: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 11:06:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:06:10 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:06: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 11:06: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 11:06: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 11:06: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 11:06:10 INFO - Downloading docopt-0.6.1.tar.gz 11:06:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:06:10 INFO - Installing collected packages: blobuploader, requests, docopt 11:06:10 INFO - Running setup.py install for blobuploader 11:06:10 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:06:10 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:06:11 INFO - Running setup.py install for requests 11:06:11 INFO - Running setup.py install for docopt 11:06:11 INFO - Successfully installed blobuploader requests docopt 11:06:11 INFO - Cleaning up... 11:06:11 INFO - Return code: 0 11:06:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:06:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:11 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/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:11 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:06:11 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:06:11 INFO - Using env: {'DISPLAY': ':0', 11:06:11 INFO - 'HOME': '/home/cltbld', 11:06:11 INFO - 'LANG': 'en_US.UTF-8', 11:06:11 INFO - 'LANGUAGE': 'en_US:en', 11:06:11 INFO - 'LOGNAME': 'cltbld', 11:06:11 INFO - 'MAIL': '/var/mail/cltbld', 11:06:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:11 INFO - 'MOZ_NO_REMOTE': '1', 11:06:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:11 INFO - 'NO_EM_RESTART': '1', 11:06:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:11 INFO - 'PWD': '/builds/slave/test', 11:06:11 INFO - 'SHELL': '/bin/bash', 11:06:11 INFO - 'SHLVL': '1', 11:06:11 INFO - 'TERM': 'linux', 11:06:11 INFO - 'TMOUT': '86400', 11:06:11 INFO - 'USER': 'cltbld', 11:06:11 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:11 INFO - '_': '/tools/buildbot/bin/python'} 11:06:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:06:11 INFO - Running setup.py (path:/tmp/pip-RRnlVM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:06:11 INFO - Running setup.py (path:/tmp/pip-wQed_6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:06:11 INFO - Running setup.py (path:/tmp/pip-Uisokg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:06:11 INFO - Running setup.py (path:/tmp/pip-52XZjv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:06:12 INFO - Running setup.py (path:/tmp/pip-5aTeML-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:06:12 INFO - Running setup.py (path:/tmp/pip-bYkuvu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:06:12 INFO - Running setup.py (path:/tmp/pip-1sOT92-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:06:12 INFO - Running setup.py (path:/tmp/pip-44api5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:06:12 INFO - Running setup.py (path:/tmp/pip-wrml4j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:06:12 INFO - Running setup.py (path:/tmp/pip-CgkUZs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:06:12 INFO - Running setup.py (path:/tmp/pip-PzyTd9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:06:12 INFO - Running setup.py (path:/tmp/pip-dEM5Z0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:06:12 INFO - Running setup.py (path:/tmp/pip-1cCZ07-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:06:12 INFO - Running setup.py (path:/tmp/pip-hnqXfg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:06:12 INFO - Running setup.py (path:/tmp/pip-lSZvDb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:06:12 INFO - Running setup.py (path:/tmp/pip-7507Ct-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:06:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:06:12 INFO - Running setup.py (path:/tmp/pip-WpiiRW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:06:12 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:06:12 INFO - Running setup.py install for manifestparser 11:06:13 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Running setup.py install for mozcrash 11:06:13 INFO - Running setup.py install for mozdebug 11:06:13 INFO - Running setup.py install for mozdevice 11:06:13 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Running setup.py install for mozfile 11:06:13 INFO - Running setup.py install for mozhttpd 11:06:13 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Running setup.py install for mozinfo 11:06:13 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Running setup.py install for mozInstall 11:06:13 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Running setup.py install for mozleak 11:06:13 INFO - Running setup.py install for mozlog 11:06:13 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:06:13 INFO - Running setup.py install for moznetwork 11:06:14 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:06:14 INFO - Running setup.py install for mozprocess 11:06:14 INFO - Running setup.py install for mozprofile 11:06:14 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:06:14 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:06:14 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:06:14 INFO - Running setup.py install for mozrunner 11:06:14 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:06:14 INFO - Running setup.py install for mozscreenshot 11:06:14 INFO - Running setup.py install for moztest 11:06:14 INFO - Running setup.py install for mozversion 11:06:14 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:06:14 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:06:14 INFO - Cleaning up... 11:06:14 INFO - Return code: 0 11:06:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:06:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:14 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/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:14 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:06:14 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:06:14 INFO - Using env: {'DISPLAY': ':0', 11:06:14 INFO - 'HOME': '/home/cltbld', 11:06:14 INFO - 'LANG': 'en_US.UTF-8', 11:06:14 INFO - 'LANGUAGE': 'en_US:en', 11:06:14 INFO - 'LOGNAME': 'cltbld', 11:06:14 INFO - 'MAIL': '/var/mail/cltbld', 11:06:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:14 INFO - 'MOZ_NO_REMOTE': '1', 11:06:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:14 INFO - 'NO_EM_RESTART': '1', 11:06:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:14 INFO - 'PWD': '/builds/slave/test', 11:06:14 INFO - 'SHELL': '/bin/bash', 11:06:14 INFO - 'SHLVL': '1', 11:06:14 INFO - 'TERM': 'linux', 11:06:14 INFO - 'TMOUT': '86400', 11:06:14 INFO - 'USER': 'cltbld', 11:06:14 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:14 INFO - '_': '/tools/buildbot/bin/python'} 11:06:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:06:14 INFO - Running setup.py (path:/tmp/pip-JQUHqL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:06:15 INFO - Running setup.py (path:/tmp/pip-YbEFxJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:06:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:06:15 INFO - Running setup.py (path:/tmp/pip-Ta52da-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:06:15 INFO - Running setup.py (path:/tmp/pip-8z3PPn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:06:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:06:15 INFO - Running setup.py (path:/tmp/pip-hgBvl1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:06:15 INFO - Running setup.py (path:/tmp/pip-p7CZ3_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:06:15 INFO - Running setup.py (path:/tmp/pip-VLfzFI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:06:15 INFO - Running setup.py (path:/tmp/pip-wzUodr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:06:15 INFO - Running setup.py (path:/tmp/pip-P8gWw3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:06:15 INFO - Running setup.py (path:/tmp/pip-Uov6b4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:06:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:06:15 INFO - Running setup.py (path:/tmp/pip-c6Hqse-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:06:15 INFO - Running setup.py (path:/tmp/pip-1Q7uky-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:06:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:06:15 INFO - Running setup.py (path:/tmp/pip-pJKPVb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:06:15 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:06:15 INFO - Running setup.py (path:/tmp/pip-aaq4QF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:06:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 11:06:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:06:15 INFO - Running setup.py (path:/tmp/pip-WGv4gp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:06:16 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)) 11:06:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:06:16 INFO - Running setup.py (path:/tmp/pip-HnCnDt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:06:16 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 11:06:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:06:16 INFO - Running setup.py (path:/tmp/pip-0GcGA_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:06:16 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)) 11:06:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:06:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 11:06:16 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)) 11:06:16 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:06:16 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 11:06:16 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:06:16 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 11:06:16 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 11:06:16 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 11:06:16 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 11:06:17 INFO - Downloading blessings-1.6.tar.gz 11:06:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:06:17 INFO - Installing collected packages: blessings 11:06:17 INFO - Running setup.py install for blessings 11:06:17 INFO - Successfully installed blessings 11:06:17 INFO - Cleaning up... 11:06:17 INFO - Return code: 0 11:06:17 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:06:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:06:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:06:17 INFO - Reading from file tmpfile_stdout 11:06:17 INFO - Current package versions: 11:06:17 INFO - argparse == 1.2.1 11:06:17 INFO - blessings == 1.6 11:06:17 INFO - blobuploader == 1.2.4 11:06:17 INFO - docopt == 0.6.1 11:06:17 INFO - functools32 == 3.2.3-2 11:06:17 INFO - jsonschema == 2.5.1 11:06:17 INFO - manifestparser == 1.1 11:06:17 INFO - mozInstall == 1.12 11:06:17 INFO - mozcrash == 1.0 11:06:17 INFO - mozdebug == 0.1 11:06:17 INFO - mozdevice == 0.50 11:06:17 INFO - mozfile == 1.2 11:06:17 INFO - mozhttpd == 0.7 11:06:17 INFO - mozinfo == 0.9 11:06:17 INFO - mozleak == 0.1 11:06:17 INFO - mozlog == 3.4 11:06:17 INFO - moznetwork == 0.27 11:06:17 INFO - mozprocess == 0.25 11:06:17 INFO - mozprofile == 0.28 11:06:17 INFO - mozrunner == 6.13 11:06:17 INFO - mozscreenshot == 0.1 11:06:17 INFO - mozsystemmonitor == 0.3 11:06:17 INFO - moztest == 0.8 11:06:17 INFO - mozversion == 1.4 11:06:17 INFO - psutil == 3.1.1 11:06:17 INFO - requests == 1.2.3 11:06:17 INFO - wsgiref == 0.1.2 11:06:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:06:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:17 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/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:17 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 11:06:17 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:06:17 INFO - Using env: {'DISPLAY': ':0', 11:06:17 INFO - 'HOME': '/home/cltbld', 11:06:17 INFO - 'LANG': 'en_US.UTF-8', 11:06:17 INFO - 'LANGUAGE': 'en_US:en', 11:06:17 INFO - 'LOGNAME': 'cltbld', 11:06:17 INFO - 'MAIL': '/var/mail/cltbld', 11:06:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:17 INFO - 'MOZ_NO_REMOTE': '1', 11:06:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:17 INFO - 'NO_EM_RESTART': '1', 11:06:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:17 INFO - 'PWD': '/builds/slave/test', 11:06:17 INFO - 'SHELL': '/bin/bash', 11:06:17 INFO - 'SHLVL': '1', 11:06:17 INFO - 'TERM': 'linux', 11:06:17 INFO - 'TMOUT': '86400', 11:06:17 INFO - 'USER': 'cltbld', 11:06:17 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:17 INFO - '_': '/tools/buildbot/bin/python'} 11:06:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 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)) 11:06:17 INFO - Cleaning up... 11:06:17 INFO - Return code: 0 11:06:17 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:06:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:06:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:06:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1cba1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e87a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202d5c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, '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': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', '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 11:06:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 11:06:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 11:06:17 INFO - Using env: {'DISPLAY': ':0', 11:06:17 INFO - 'HOME': '/home/cltbld', 11:06:17 INFO - 'LANG': 'en_US.UTF-8', 11:06:17 INFO - 'LANGUAGE': 'en_US:en', 11:06:17 INFO - 'LOGNAME': 'cltbld', 11:06:17 INFO - 'MAIL': '/var/mail/cltbld', 11:06:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:17 INFO - 'MOZ_NO_REMOTE': '1', 11:06:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:17 INFO - 'NO_EM_RESTART': '1', 11:06:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:17 INFO - 'PWD': '/builds/slave/test', 11:06:17 INFO - 'SHELL': '/bin/bash', 11:06:17 INFO - 'SHLVL': '1', 11:06:17 INFO - 'TERM': 'linux', 11:06:17 INFO - 'TMOUT': '86400', 11:06:17 INFO - 'USER': 'cltbld', 11:06:17 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:17 INFO - '_': '/tools/buildbot/bin/python'} 11:06:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:06:18 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:06:18 INFO - Cleaning up... 11:06:18 INFO - Return code: 0 11:06:18 INFO - Running post-action listener: _resource_record_post_action 11:06:18 INFO - Running post-action listener: _start_resource_monitoring 11:06:18 INFO - Starting resource monitoring. 11:06:18 INFO - [mozharness: 2017-05-22 18:06:18.228901Z] Finished create-virtualenv step (success) 11:06:18 INFO - [mozharness: 2017-05-22 18:06:18.229480Z] Running install step. 11:06:18 INFO - Running pre-action listener: _resource_record_pre_action 11:06:18 INFO - Running main action method: install 11:06:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:06:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:06:18 INFO - Reading from file tmpfile_stdout 11:06:18 INFO - Detecting whether we're running mozinstall >=1.0... 11:06:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:06:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:06:18 INFO - Reading from file tmpfile_stdout 11:06:18 INFO - Output received: 11:06:18 INFO - Usage: mozinstall [options] installer 11:06:18 INFO - Options: 11:06:18 INFO - -h, --help show this help message and exit 11:06:18 INFO - -d DEST, --destination=DEST 11:06:18 INFO - Directory to install application into. [default: 11:06:18 INFO - "/builds/slave/test"] 11:06:18 INFO - --app=APP Application being installed. [default: firefox] 11:06:18 INFO - mkdir: /builds/slave/test/build/application 11:06:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 11:06:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 11:06:34 INFO - Reading from file tmpfile_stdout 11:06:34 INFO - Output received: 11:06:34 INFO - /builds/slave/test/build/application/firefox/firefox 11:06:34 INFO - Running post-action listener: _resource_record_post_action 11:06:34 INFO - [mozharness: 2017-05-22 18:06:34.642093Z] Finished install step (success) 11:06:34 INFO - [mozharness: 2017-05-22 18:06:34.642372Z] Running run-tests step. 11:06:34 INFO - Running pre-action listener: _resource_record_pre_action 11:06:34 INFO - Running main action method: run_tests 11:06:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:06:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:06:34 INFO - Python 2.7.3 11:06:34 INFO - Return code: 0 11:06:34 INFO - grabbing minidump binary from tooltool 11:06:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 11:06:34 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 0x202a7a0>, '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 0x202b6a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x202bb30>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:06:34 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 11:06:34 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 11:06:34 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 11:06:34 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:06:34 INFO - Return code: 0 11:06:34 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:06:34 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:06:34 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:06:34 INFO - ENV: RUST_BACKTRACE is now 1 11:06:34 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:06:34 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:06:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-040', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 11:06:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-040 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 11:06:34 INFO - Using env: {'DISPLAY': ':0', 11:06:34 INFO - 'HOME': '/home/cltbld', 11:06:34 INFO - 'LANG': 'en_US.UTF-8', 11:06:34 INFO - 'LANGUAGE': 'en_US:en', 11:06:34 INFO - 'LOGNAME': 'cltbld', 11:06:34 INFO - 'MAIL': '/var/mail/cltbld', 11:06:34 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:06:34 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:06:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:06:34 INFO - 'MOZ_NO_REMOTE': '1', 11:06:34 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:06:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:06:34 INFO - 'NO_EM_RESTART': '1', 11:06:34 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:06:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:06:34 INFO - 'PWD': '/builds/slave/test', 11:06:34 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:06:34 INFO - 'RUST_BACKTRACE': '1', 11:06:34 INFO - 'SHELL': '/bin/bash', 11:06:34 INFO - 'SHLVL': '1', 11:06:34 INFO - 'TERM': 'linux', 11:06:34 INFO - 'TMOUT': '86400', 11:06:34 INFO - 'USER': 'cltbld', 11:06:34 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754', 11:06:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:06:34 INFO - '_': '/tools/buildbot/bin/python'} 11:06:34 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-040', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 11:06:34 INFO - mozversion application_buildid: 20170522172811 11:06:34 INFO - mozversion application_changeset: f9ca97a334296facd2e0ea5582e7f12d0fe70fe4 11:06:34 INFO - mozversion application_display_name: Nightly 11:06:34 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:06:34 INFO - mozversion application_name: Firefox 11:06:34 INFO - mozversion application_remotingname: firefox 11:06:34 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 11:06:34 INFO - mozversion application_vendor: Mozilla 11:06:34 INFO - mozversion application_version: 55.0a1 11:06:34 INFO - mozversion platform_buildid: 20170522172811 11:06:34 INFO - mozversion platform_changeset: f9ca97a334296facd2e0ea5582e7f12d0fe70fe4 11:06:34 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 11:06:34 INFO - mozversion platform_version: 55.0a1 11:06:34 INFO - using testdate: 1495476394 11:06:34 INFO - actual date: 1495476394 11:06:34 INFO - starting webserver on 'localhost:59872' 11:06:34 INFO - SUITE-START | Running 2 tests 11:06:34 INFO - TEST-START | dromaeo_css 11:06:34 INFO - operating with platform_type : linux_ 11:06:34 INFO - Initialising browser for dromaeo_css test... 11:06:34 INFO - TEST-INFO | started process 4906 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpG5jj0w/profile http://localhost:59872/getInfo.html) 11:06:35 INFO - PID 4906 | JavaScript warning: resource://gre/modules/addons/XPIProvider.jsm, line 2978: String.localeCompare is deprecated; use String.prototype.localeCompare instead 11:06:39 INFO - PID 4906 | __metrics Screen width/height:1600/1200 11:06:39 INFO - PID 4906 | colorDepth:24 11:06:39 INFO - PID 4906 | Browser inner width/height: 1024/695 11:06:39 INFO - PID 4906 | __metrics 11:06:41 INFO - TEST-INFO | 4906: exit 0 11:06:41 INFO - Browser initialized. 11:06:41 INFO - Running cycle 1/1 for dromaeo_css test... 11:06:41 INFO - TEST-INFO | started process 5089 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpG5jj0w/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:06:52 INFO - PID 5089 | RSS: Main: 171241472 11:06:52 INFO - PID 5089 | 11:09:57 INFO - PID 5089 | Cycle 1(1): loaded http://localhost:59872/tests/dromaeo/cssquery-dojo.html (next: http://localhost:59872/tests/dromaeo/cssquery-ext.html) 11:09:59 INFO - PID 5089 | RSS: Main: 173756416 11:09:59 INFO - PID 5089 | 11:13:01 INFO - PID 5089 | Cycle 1(1): loaded http://localhost:59872/tests/dromaeo/cssquery-ext.html (next: http://localhost:59872/tests/dromaeo/cssquery-jquery.html) 11:13:02 INFO - PID 5089 | RSS: Main: 172675072 11:13:02 INFO - PID 5089 | 11:16:03 INFO - PID 5089 | Cycle 1(1): loaded http://localhost:59872/tests/dromaeo/cssquery-jquery.html (next: http://localhost:59872/tests/dromaeo/cssquery-mootools.html) 11:16:04 INFO - PID 5089 | RSS: Main: 174903296 11:16:04 INFO - PID 5089 | 11:19:06 INFO - PID 5089 | Cycle 1(1): loaded http://localhost:59872/tests/dromaeo/cssquery-mootools.html (next: http://localhost:59872/tests/dromaeo/cssquery-prototype.html) 11:19:07 INFO - PID 5089 | RSS: Main: 171827200 11:19:07 INFO - PID 5089 | 11:22:10 INFO - PID 5089 | Cycle 1(1): loaded http://localhost:59872/tests/dromaeo/cssquery-prototype.html (next: http://localhost:59872/tests/dromaeo/cssquery-yui.html) 11:22:10 INFO - PID 5089 | RSS: Main: 172003328 11:22:10 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | Cycle 1(1): loaded http://localhost:59872/tests/dromaeo/cssquery-yui.html (next: http://localhost:59872/tests/dromaeo/cssquery-dojo.html) 11:25:12 INFO - PID 5089 | RSS: Main: 181030912 11:25:12 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | __start_tp_report 11:25:12 INFO - PID 5089 | _x_x_mozilla_page_load 11:25:12 INFO - PID 5089 | _x_x_mozilla_page_load_details 11:25:12 INFO - PID 5089 | |i|pagename|runs| 11:25:12 INFO - PID 5089 | |0;dojo.html;2701.8784154713035;2730.767884729798;2732.7267273272673;2761.1026416414657;2766.170148955313;5118.9744051279695;5248.002879452902;5248.370195576536;5249.711265880375;5290.550303224226;5188.325517682696;5189.506996835304;5200.635955483118;5272.472752724726;5287.629865909388;4593.678442509025;4654.115718013583;4672.299155126741;4707.199776038065;4710.411198600166;4684.320773487842;4734.644901632374;4748.287756836485;4753.857384278477;4781.7370044647705;4595.287730401793;4620.468646105707;4634.814607415699;4664.230401983668;4679.134360143385;4673.719576825401;4677.111348843709;4681;4707.199776038082;4724.976375118103;4576.610988066019;4635.768211589407;4640.67515273931;4658.58072773452;4664.113818374498;5030.698158110525;5150.871228219287;5202.557782588485;5205.219217117425;5244.842654720364;5590.91613625796;5603.439656034405;5658.321001479808;5659.830205093854;5661.094224924033;5534.972325138348;5558.888822223574;5559.138333558305;5562.471565201299;5565.3599836018975;5155.484451554815;5169.974150129226;5187.351581052369;5196.818111366122;5220.530152286313;5723.198752174699;5725.227094342211;5735.684537350486;5744.224529688522;5746;5475.4524547544925;5484.890302193934;5546.750396232179;5562.082256427644;5562.276904002454;5616.971915140398;5642.689652069093;5643.266375371258;5653.745581448845;5702.657840529581;5469.972650136724;5578.97210513953;5587.636803607753;5588.6646801192055;5596.2165296858475;5454.4545545445135;5536.557075433956;5591.832245032656;5594.748236329375;5657.12314591239;4575.22221222393;4585.899384147847;4646.83736069236;4647.024124933734;4653.557911998355;3986.6412022918075;3993.4608827808456;4010.5187377514885;4026.63760261572;4054.2904991626347;4636.884077898079;4694.788734506956;4702.717836929795;4712.151812673752;4719.10337035962;5486.890262194734;5505.752241149158;5585.134304182858;5595.281902356036;5602;4741.739204343725;4756.405449318835;4760.262159365304;4760.785764640599;4768.904621907543;4917.704937703749;4938.111139994836;4962.975185124052;5019.196928491424;5022.4977502249485;5207.817726379559;5215.165573508372;5254.15933450646;5271.393789714155;5314.7874085036165;5483.698396588226;5513.862153446196;5599.664020158803;5655.519280861008;5659.801906933238;5196.584273258206;5231.659942103751;5235.528802407802;5282.603804714585;5292.41783403833;5432.212329212163;5490;5504.834854954358;5534.142207957773;5553.4724201200825;5540.1135818270495;5615.241942337732;5654.802081927113;5664.631798933056;5683.318001839806;5342.3856256531;5430.891382172255;5442.673439593637;5457.945420545744;5481.945180548303;5386.730663466733;5391.568674506108;5394.703291319015;5398.082326004667;5404.108322126962;5284.471552844685;5292.5501332387175;5305.628605997543;5317.468253174651;5322.121849894879;5328.040952628564;5399.70301633414;5415.539679127318;5417.322834645669;5419.0245755764345;5257.447967963309;5274.841754747364;5286.841394758163;5290.65610735301;5323.0950738373795 11:25:12 INFO - PID 5089 | |1;ext.html;591.7514643849582;649.1690635985938;663.7013343995201;1164.0920082335776;1176.5411489519083;33310.33379332412;34341;34367.31265374691;34397.48403773939;34482.137946551346;32549.186270343253;33053.504197437054;33085.33829323412;33142.68001239914;33155.834220828925;6455.967720161404;6800.183977922657;6982.092327997353;6983.790486285419;6995.79012629622;6876.449884009267;6990.790276291719;6993.580385176881;6998.195207551121;7000.754973575926;6956.060931774222;7017.403520700746;7024.332688394595;7031.050808140887;7038.120234970629;6924.653767311639;6953.130858642669;6954.165500140016;6959.1996920353795;6981.197162326347;6920.5847649141215;6976.302369763034;6978.197507286676;6997.895031574531;7003.15962084548;31545.21136971571;31560.526592101138;31828.522572161437;31839;31901.52147717786;3097.6902309769066;3116.1274843043984;3123.7344825689843;3129.85915633797;3131.2171957010746;24243.636345454834;24287;24423.63364549533;24446.26661200167;24479.143229986865;2968.7328140467243;2993.790434669574;3024.2892920163745;3051.6338039435186;3084.981955954552;147153;147310;147606.26196869055;159061;163493.18253408777;37677.81161094177;38234;38316;38317.23365532674;38357.424638630444;40412.393814092815;40428;40497.392539111934;42142.57857421448;43060.56939430628;10768.892311076946;10815.351078935131;10948.890511094947;11000.834987475195;11003.33979961189;7994.5602991836;8008.679652813938;8012.399070069651;8062;8100.878486822702;12416.503339866304;12441.066919981038;12478.81281780774;12487.562935297221;12741.362931853555;5187.403448603459;5271.128749294022;5333.706646134422;5368.8389348319615;5437.510624043776;872.8996165440929;880.9735707928644;896.3980285199589;909.7907481279343;936.091990768953;20484.078216479997;21224.469388265417;21483.78516214849;21583.56832863334;21719.67420488694;962.7593101724569;968.4431451915177;990.2276224544867;991.7371896447447;998.1515711645044;10958.890411095947;11074.889251107386;11134.888651113386;11287;11374.658760237206;157737.21131394498;163221;163595;164028;185800;42062;42605.36091958623;42832.78583607062;43127.137457250676;43238;1200.4897918384652;1216.6836622478043;1224.063591352616;1226.6749311432657;1228.784962631536;24221.394465138514;24278.878605607566;24783.50432991366;25379.74620253774;25433.745662543137;29502.852485737432;35819;36516;36578.26843463169;36609.45085823662;160859.19570402073;162308;162395;162428;162644.18677906535;29265.85367073151;29270.70729292765;29290.267743306587;29573.408531828813;29664.703352966193;34191.4871276936;34758.30483390368;35467.64532354747;35595;35785.1053723659;26193.4761304769;26388.736112638628;27174.29339838577;27676.584851226846;27825.860870695516;26368.8681556591;26447.471050579265;26644.866775666775;27777.166684999484;27850.582241266802;29068;29418.264543386587;29714.405711886073;29833.403331933674;30035.849820750755;26227.868860656337;26518.469630607666;26629.334266643487;26858.865705671345;27605.171844844688;21301.57396852023;22145.778542215015;22189.778102219418;22274.549799522363;22373.552528949655 11:25:12 INFO - PID 5089 | |2;jquery.html;395.3200495148344;396.5281315234872;415.0640306109721;424.2977871622465;426.976516291604;16725.163741812907;17399;17428.651426971453;17493.562660933483;18230.0884955752;17151.313947442086;17252.82747172528;17373.30506779727;17917.820821791778;18027.639447211048;5210.869728256805;5223.294855194547;5315.229291752694;5416.350037995427;5428.782848686048;5232.45059268777;5346.759395827197;5356.892862142755;5377.623566350357;5381.973090134544;5179.171332586787;5232.659877107976;5280;5305.761240744157;5355.384130824966;5365.356157261134;5411.83764487066;5415.13357862744;5430.5384042356645;5437;4680.789364478606;4839.322494850724;4882.707037577757;4895.755212239374;4910.877228069291;21389.144434222613;21433.78566214349;21516.89241553798;21697;21899.124035038578;1606.9598260043476;1633.2405431474303;1636.443609172887;1641.0973964319696;1644.1779110444777;14311.141331520039;15197.164155971417;15234.390624375012;15324.923375383052;15344.616384590363;1986.8708533945392;2062.9071691773756;2096.5702031083592;2106.6208082545136;2115.809577138065;75755.24244757537;76453.85319220216;77356.22643773603;77662.22337776606;78461.21538784596;10292.536835842406;10440.634577789893;10569.682909512727;10633.308834925705;10686.732831679115;13942.58172254834;13956.930215348859;14021.088629239272;14035.929820350833;14054.508092216927;6410.1987251593555;6568.343165683489;6575.276719560845;6737.157855268091;6752.527323087336;5813;5830.912536311958;6006.489448396936;6009.759609615567;6040.879182416327;6626.53614246998;6784.151981002375;6807;6811.761588344483;6987.930120698829;2015.2241387065792;2016.385002574229;2025.3822584111988;2038.7043878637514;2049.2008116834445;874.3879284500874;899.6761165980242;904.7059705595576;910.6676063236871;929.8605209218535;17195;17220.311187552357;17990.280388784562;18037;18166.455006349832;887.1616322575234;895.4716717136921;900.2123142250531;909.7725568607848;931.9301052421096;9379.577918993662;9411.6705915294;9780.755481112887;9806.16075152426;9928.652497162564;344611;346019;348357;354859;357584;74617.62691186617;81190;82652;83037.58481207555;83609.58195208985;1059.6185373265619;1059.6397224943403;1103.9779204415868;1111.5442668506034;1121.46730303107;17535.736963945295;17657.823421765617;18247.178876950835;18311.816881831543;18538.443846684622;39585.406218907316;40030.11807882555;40339.596604034756;41485.37771933363;41751.373729393476;51347.48652513427;51769.741151294;52355;53784.46215537794;54089;11904.226225295328;12114.454849531616;12191;12333.814992775295;12444.128910976146;12824;13037.817452597206;13111.60665180046;13528.797068044185;13549.322533873465;11142.498587563741;11421.486033128363;11486.253393529394;11588.072954163477;11863.390054188065;10484.26610137283;10904.236703430684;10959.342439453658;10991.945040274748;11026.173037022096;11400.429978501208;11416.086713063101;11421.31472111676;11442.885571144516;11734.765304694029;11916.404179790803;12037.879621203676;12084.39578021113;12214.328211948428;12471.189372690746;11107.555697771999;11163.330200188015;11295.548178072784;11598.652040438801;11639.6508104757 11:25:12 INFO - PID 5089 | |3;mootools.html;1245.3399698159976;1304.165334186121;1304.3478260869567;1307.3267267357307;1322.623052430057;9493.810123797528;9835.901640983588;9869.062439068277;9936.55285512152;10007.599696012168;9773.462459564722;9895.109440150385;9942;9958.751031224205;9985.101340879319;2228.1533017453344;2248.57277117348;2257.7516473187934;2268.750437451879;2271.659251112338;2168.8590241634324;2212.2920665387082;2217.3791338425267;2223.032980653421;2224.065892325219;2164.7618761936255;2175.749788774295;2208.094681180716;2214.2914267434426;2214.900329485177;2165.5127596290868;2181.9345419637434;2201.9559608807813;2206.470447092694;2208.1940091866513;2039.7042428847883;2176.967345489819;2188.190369563256;2195.484061245606;2205.3935167828813;9086.091390860927;9195.586198621011;9215.493147876865;9238.491882946435;9251;5173.715445650488;5348.946510534923;5376.489233522809;5390.595705322077;5435.266239057716;3154.2429816844024;3245.5293982372423;3286.6549012353835;3323.567936168283;3400.387930172568;1082.8050950828847;1084.5770149641646;1121.899029087386;1131.5473810475794;1142.5715356741223;13871.306434678225;13938;13945.721085578332;13959.511417100353;14028.228447435387;4379.299312110111;4635.351050852883;4677.6959497633225;4693.6949098308505;4755.785989630475;10033.749156271006;10062.496875156214;10129.898701013042;10130.24023198263;10131.290809643255;5266.92099618506;5303.708296043677;5311.309529761106;5321.32378300834;5330.733463326896;4686.507916668701;4938.407391113089;4951.480094590088;4986.476419975923;5025.3718285214345;3591.28174365128;3690.634465247822;3705.4256590228556;3752.681022113151;3772.2078363543415;1034.9793004139874;1041.6250149946013;1043.4678314059884;1046.1892033673812;1055.9260851740305;689.1076056506836;708.479267738212;710.733474946895;726.7129483853848;729.1978823294334;5020.748962551931;5133.640645154878;5156.587473002151;5221.190715439113;5267.604929630293;542.552394274725;553.3221803291017;553.3885057011944;553.6456667732655;554.7780887644893;3333.9166520837175;3383.8308084595674;3496;3554.377983852867;3631.94552081719;11888.227265227733;12324;12338.50645974169;12405.255684658949;12506;12309.26144431337;12328.81506777399;12357.691057723448;12359.073069519822;12374.257544547356;6467.126937863422;6767.35710107539;6877.071595334766;6996.195437524648;7114.181869085121;5624.775008999594;5641.379448260606;5741.110127930177;5774.682392468455;5958;10441.425721585385;10756.569737210424;10792.136629069499;10835.187360947803;10879.836802447811;10583.523741431809;10841.132709383073;10917.454127293444;10924.726881828017;10943.28868623537;7614.847703046019;7736.1877002916135;7748.806279843049;7786.299233069051;8139.511629302261;9202.677906273248;9352.298577606844;9438.764030899283;9442.52787360643;9459;7442.181360050498;7549.0941087069905;7571.659275332733;7605.23947605235;7798.493097948615;7411.4811963162065;7419.369353605004;7460;7579.734709285149;7588.8482230353975;6563.278039415565;6682.966585167237;6762.188537375547;6784.93215067843;6819.4544436443975;4733.219018861849;5066.797328106834;5090;5154.948450515447;5206.349206349207;4889.217725163957;5019.874503137451;5059.443461219336;5097.8215762448135;5099.388073431212 11:25:12 INFO - PID 5089 | |4;prototype.html;380.9009657489052;385.4083981089029;390.6308538431183;390.99022524436884;396.8432469174678;5364.865878353038;5416.322959630046;5421.593380496463;5423.945760542393;5457.345118585766;5239.633225674204;5254.57963362931;5297.728545149165;5300.655457395266;5332.280142180814;4190.120074784284;4203.327467605184;4212.115455754295;4213.9578604213875;4237.258479766044;4178.331466965286;4206.621404073633;4215.473065866767;4240.3851441540955;4247.723897946639;4108.712390132692;4175.937360939588;4204.600562946515;4213.641840443551;4230.19626271009;4171.20747058061;4176.220520429017;4186.769727664977;4190.28765109929;4191.580841915815;3743.6630703236838;3752.6247375262255;3774.9049277650893;3775.924481510382;3777.471154038437;5138.332016837825;5241.187615919539;5261.263423120766;5278.973605131988;5295.4704529547125;4889.8777530561665;4929.383827021622;4946.159152944008;4952.801887924515;4955.82654607087;5649.0114230009585;5658.6516595612775;5672.177534257509;5673.546116310686;5713.257276554022;4193.979030104861;4226.239276930151;4247.681423893189;4264.637505812009;4272.786360681985;5778.942210577882;5898.852528686774;5932.851678708023;5939.46544810969;6018.15745795589;3993.341098718737;4053.128577355824;4053.493313335833;4067.3085575452246;4076.5719599442223;4117.341225403981;4138.420621113047;4139.275626765304;4140.047789008545;4148.958510414917;4699.224627936421;4772.4228916385455;4777.092352453023;4792.760361981887;4805.111054454937;5729.393126127602;5739.569532285095;5750.281214848144;5752.769889204469;5767.307923049261;1422.907511011781;1426.3866537388815;1427.4932398998415;1428.8213973253344;1431.8616699723746;908.1372695938885;947.9715608531756;957.1816097236763;967.5355829202023;968.3173362779223;4941.629377796679;4942.110420124341;4943.604511639061;4953.7523123844385;4958.504149585013;5892.7642894283745;5895.882082358415;5900.734466948998;5912.970435147797;5963.970180149158;4781.163296423112;4863.416390033219;4913.631477639191;4921.680090794159;4935.703857768545;3099.024936061361;3132.263917979273;3133.5299705044426;3142.98428507856;3145.496720524751;5438.6736795791585;5510.980468613319;5539.169124631338;5554.50009499147;5562;6079.574429789961;6093.817185484442;6112.847178820476;6113.908291375544;6117.449429551361;5513.61404701667;5552.139418390156;5560.165975103767;5562.888742225214;5568;5704.201411802268;5902.911456328073;5910.290765108214;5944.791932282349;5965.73154208053;5821.912671309849;5839.328477225174;5840.474357307863;5885.205497257986;5932.199153114447;5295.417504074626;5555.638883472561;5562.5549956002615;5568.860778480571;5578.748956297058;4088.0801819590356;4113.341865301538;4113.4035564843525;4119.340905455113;4126.690498212586;5831.94168058314;5997.610155339889;6005.219321488178;6019.428154325507;6022.969885150546;5699.230603868425;5721.799737009184;5763.740631671669;5787.681677507778;5804.593678442468;5752.741126649395;5754.468034064998;5779.566532510163;5787.826365209051;5801.622894511843;5492.286002819608;5666.2350582670815;5684.953416769877;5693.943060569507;5703.686297253691;5800.477956983892;5816.680082595329;5822.679752613647;5823.272090988627;5842.620229685057;5424.321959755031;5604.9084168556365;5606.542299002371;5611.354694210055;5613.129964855454 11:25:12 INFO - PID 5089 | |5;yui.html;730.4850080693112;746.2798399544439;751.5340488896885;755.3503986571549;787.7321710618388;11885.702857428569;12243.877561224384;13388.598342049741;13941.093828901114;13982.510612128564;14084.92957535211;14415.63960900978;14566;14591.708165836704;14630.634234144152;813.662330132994;838.0739283092187;838.329336530776;840.2395831772226;841.4194205997873;880.7093659092484;884.9513276769775;887.3078998381272;888.1873086126219;888.4979986307748;913.2009491694768;914.8216097860919;916.097643820836;916.6562539047857;918.4626993208981;900.7973206028656;907.5326207003366;907.8048219632777;908.500324821349;909.9772505687345;671.8488340123482;672.831792051987;672.862063277027;673.7709178879155;674.2953613473883;13288.534901278408;13411.329433528284;13424.32878356088;13685.11046781956;13958.930205348908;13506.32468376587;13543.187408755506;13662.590122296348;13764.724705505834;13846.93076534621;11916.404179791063;12056.336901470415;12143.271403715717;12166.452509637087;12197;2871.956920646192;2902.840343781091;2922.503174460347;2934.823910565373;2939.382729626781;65675;65765.34234657687;66433.66783166054;66897;67051;10500.842487362695;10511.106555942677;10600.469976501145;10619.469026548642;10738.355698658106;17088.145592720313;17110.14449277531;17115.74326385105;17186.31254749821;17191.484255472355;5702.372738998707;5820.214271073351;5884.58807883444;5887.2052272943465;5897.7935772247765;2737.178846346088;2779.680336761258;2797.342624483245;2800.327921298914;2814.620026296465;3404.744644151649;3434.3131373725355;3447.0692912913373;3464.4456886897974;3497.877574284888;666.9699863506154;672.5225090185925;673.1787219592089;673.7978606418055;675.6385333846368;598.3149294058279;609.2262826210688;615.9928516874852;618.8236352639476;620.2804746494136;9401.294902882311;10211.693649190536;10216.131628811485;10598.576056957789;11030.22788404804;588.0297509110003;588.3704436253169;596.6569222696967;605.0349692240869;612;4425.114977004612;4539.137563862855;4565.246734288871;4569.268916973335;4569.634429245652;58626.70686646625;61167;63203.36796631975;63432.97386748251;63725.36274637287;54087;54233.457665422844;54450.18324725132;56167.71916140393;56498.43501565014;44050.55949440529;49604;50010;50557;51693.48306516962;10580.259381843198;10771.29986550903;11178.329300242012;11284.830727539258;11410.372429516125;24103;24564.754352456246;25157.11950081738;25781.613275800504;25922.481550369263;40617;41011.58988410078;41859.1628167441;42082.368764467945;43211;13627.38676759568;13831.792523112363;13882.375293111632;14046.578602641937;14064.929675351557;15305.158216297765;15464.613384665023;15847.683046338778;15853.048817071012;16151.67696646084;14086.788698169741;14229.288535573387;14521.636959075686;14548.345324460637;14594.635134121732;13321.467141314239;13325.933370333087;13467.057305988486;13677.931610341884;13888.791668125188;14210.360533775798;14292.28538573088;14388.640283992983;14451.132932024113;14608.488702895347;9506.662942866284;9566.877198593045;9713.174380177481;10000.149987251165;10076.748081298027;10937.179711521509;11370.772584548427;11483.827742584035;11542;11628.302301861915 11:25:12 INFO - PID 5089 | __end_tp_report 11:25:12 INFO - PID 5089 | __start_cc_report 11:25:12 INFO - PID 5089 | _x_x_mozilla_cycle_collect,287 11:25:12 INFO - PID 5089 | __end_cc_report 11:25:12 INFO - PID 5089 | __startTimestamp1495477512825__endTimestamp 11:25:12 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | ------- Summary: start ------- 11:25:12 INFO - PID 5089 | Number of tests: 6 11:25:12 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | [#0] dojo.html Cycles:165 Average:5115.30 Median:5282.60 stddev:589.28 (11.2%) stddev-sans-first:559.85 11:25:12 INFO - PID 5089 | Values: 2701.9 2730.8 2732.7 2761.1 2766.2 5119.0 5248.0 5248.4 5249.7 5290.6 5188.3 5189.5 5200.6 5272.5 5287.6 4593.7 4654.1 4672.3 4707.2 4710.4 4684.3 4734.6 4748.3 4753.9 4781.7 4595.3 4620.5 4634.8 4664.2 4679.1 4673.7 4677.1 4681.0 4707.2 4725.0 4576.6 4635.8 4640.7 4658.6 4664.1 5030.7 5150.9 5202.6 5205.2 5244.8 5590.9 5603.4 5658.3 5659.8 5661.1 5535.0 5558.9 5559.1 5562.5 5565.4 5155.5 5170.0 5187.4 5196.8 5220.5 5723.2 5725.2 5735.7 5744.2 5746.0 5475.5 5484.9 5546.8 5562.1 5562.3 5617.0 5642.7 5643.3 5653.7 5702.7 5470.0 5579.0 5587.6 5588.7 5596.2 5454.5 5536.6 5591.8 5594.7 5657.1 4575.2 4585.9 4646.8 4647.0 4653.6 3986.6 3993.5 4010.5 4026.6 4054.3 4636.9 4694.8 4702.7 4712.2 4719.1 5486.9 5505.8 5585.1 5595.3 5602.0 4741.7 4756.4 4760.3 4760.8 4768.9 4917.7 4938.1 4963.0 5019.2 5022.5 5207.8 5215.2 5254.2 5271.4 5314.8 5483.7 5513.9 5599.7 5655.5 5659.8 5196.6 5231.7 5235.5 5282.6 5292.4 5432.2 5490.0 5504.8 5534.1 5553.5 5540.1 5615.2 5654.8 5664.6 5683.3 5342.4 5430.9 5442.7 5457.9 5481.9 5386.7 5391.6 5394.7 5398.1 5404.1 5284.5 5292.6 5305.6 5317.5 5322.1 5328.0 5399.7 5415.5 5417.3 5419.0 5257.4 5274.8 5286.8 5290.7 5323.1 11:25:12 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | [#1] ext.html Cycles:180 Average:30513.25 Median:3126.80 stddev:41515.90 (1327.7%) stddev-sans-first:41571.57 11:25:12 INFO - PID 5089 | Values: 591.8 649.2 663.7 1164.1 1176.5 33310.3 34341.0 34367.3 34397.5 34482.1 32549.2 33053.5 33085.3 33142.7 33155.8 6456.0 6800.2 6982.1 6983.8 6995.8 6876.4 6990.8 6993.6 6998.2 7000.8 6956.1 7017.4 7024.3 7031.1 7038.1 6924.7 6953.1 6954.2 6959.2 6981.2 6920.6 6976.3 6978.2 6997.9 7003.2 31545.2 31560.5 31828.5 31839.0 31901.5 3097.7 3116.1 3123.7 3129.9 3131.2 24243.6 24287.0 24423.6 24446.3 24479.1 2968.7 2993.8 3024.3 3051.6 3085.0 147153.0 147310.0 147606.3 159061.0 163493.2 37677.8 38234.0 38316.0 38317.2 38357.4 40412.4 40428.0 40497.4 42142.6 43060.6 10768.9 10815.4 10948.9 11000.8 11003.3 7994.6 8008.7 8012.4 8062.0 8100.9 12416.5 12441.1 12478.8 12487.6 12741.4 5187.4 5271.1 5333.7 5368.8 5437.5 872.9 881.0 896.4 909.8 936.1 20484.1 21224.5 21483.8 21583.6 21719.7 962.8 968.4 990.2 991.7 998.2 10958.9 11074.9 11134.9 11287.0 11374.7 157737.2 163221.0 163595.0 164028.0 185800.0 42062.0 42605.4 42832.8 43127.1 43238.0 1200.5 1216.7 1224.1 1226.7 1228.8 24221.4 24278.9 24783.5 25379.7 25433.7 29502.9 35819.0 36516.0 36578.3 36609.5 160859.2 162308.0 162395.0 162428.0 162644.2 29265.9 29270.7 29290.3 29573.4 29664.7 34191.5 34758.3 35467.6 35595.0 35785.1 26193.5 26388.7 27174.3 27676.6 27825.9 26368.9 26447.5 26644.9 27777.2 27850.6 29068.0 29418.3 29714.4 29833.4 30035.8 26227.9 26518.5 26629.3 26858.9 27605.2 21301.6 22145.8 22189.8 22274.5 22373.6 11:25:12 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | [#2] jquery.html Cycles:180 Average:24465.06 Median:21411.47 stddev:58314.04 (272.3%) stddev-sans-first:58449.63 11:25:12 INFO - PID 5089 | Values: 395.3 396.5 415.1 424.3 427.0 16725.2 17399.0 17428.7 17493.6 18230.1 17151.3 17252.8 17373.3 17917.8 18027.6 5210.9 5223.3 5315.2 5416.4 5428.8 5232.5 5346.8 5356.9 5377.6 5382.0 5179.2 5232.7 5280.0 5305.8 5355.4 5365.4 5411.8 5415.1 5430.5 5437.0 4680.8 4839.3 4882.7 4895.8 4910.9 21389.1 21433.8 21516.9 21697.0 21899.1 1607.0 1633.2 1636.4 1641.1 1644.2 14311.1 15197.2 15234.4 15324.9 15344.6 1986.9 2062.9 2096.6 2106.6 2115.8 75755.2 76453.9 77356.2 77662.2 78461.2 10292.5 10440.6 10569.7 10633.3 10686.7 13942.6 13956.9 14021.1 14035.9 14054.5 6410.2 6568.3 6575.3 6737.2 6752.5 5813.0 5830.9 6006.5 6009.8 6040.9 6626.5 6784.2 6807.0 6811.8 6987.9 2015.2 2016.4 2025.4 2038.7 2049.2 874.4 899.7 904.7 910.7 929.9 17195.0 17220.3 17990.3 18037.0 18166.5 887.2 895.5 900.2 909.8 931.9 9379.6 9411.7 9780.8 9806.2 9928.7 344611.0 346019.0 348357.0 354859.0 357584.0 74617.6 81190.0 82652.0 83037.6 83609.6 1059.6 1059.6 1104.0 1111.5 1121.5 17535.7 17657.8 18247.2 18311.8 18538.4 39585.4 40030.1 40339.6 41485.4 41751.4 51347.5 51769.7 52355.0 53784.5 54089.0 11904.2 12114.5 12191.0 12333.8 12444.1 12824.0 13037.8 13111.6 13528.8 13549.3 11142.5 11421.5 11486.3 11588.1 11863.4 10484.3 10904.2 10959.3 10991.9 11026.2 11400.4 11416.1 11421.3 11442.9 11734.8 11916.4 12037.9 12084.4 12214.3 12471.2 11107.6 11163.3 11295.5 11598.7 11639.7 11:25:12 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | [#3] mootools.html Cycles:180 Average:5900.73 Median:4713.46 stddev:3709.10 (78.7%) stddev-sans-first:3703.01 11:25:12 INFO - PID 5089 | Values: 1245.3 1304.2 1304.3 1307.3 1322.6 9493.8 9835.9 9869.1 9936.6 10007.6 9773.5 9895.1 9942.0 9958.8 9985.1 2228.2 2248.6 2257.8 2268.8 2271.7 2168.9 2212.3 2217.4 2223.0 2224.1 2164.8 2175.7 2208.1 2214.3 2214.9 2165.5 2181.9 2202.0 2206.5 2208.2 2039.7 2177.0 2188.2 2195.5 2205.4 9086.1 9195.6 9215.5 9238.5 9251.0 5173.7 5348.9 5376.5 5390.6 5435.3 3154.2 3245.5 3286.7 3323.6 3400.4 1082.8 1084.6 1121.9 1131.5 1142.6 13871.3 13938.0 13945.7 13959.5 14028.2 4379.3 4635.4 4677.7 4693.7 4755.8 10033.7 10062.5 10129.9 10130.2 10131.3 5266.9 5303.7 5311.3 5321.3 5330.7 4686.5 4938.4 4951.5 4986.5 5025.4 3591.3 3690.6 3705.4 3752.7 3772.2 1035.0 1041.6 1043.5 1046.2 1055.9 689.1 708.5 710.7 726.7 729.2 5020.7 5133.6 5156.6 5221.2 5267.6 542.6 553.3 553.4 553.6 554.8 3333.9 3383.8 3496.0 3554.4 3631.9 11888.2 12324.0 12338.5 12405.3 12506.0 12309.3 12328.8 12357.7 12359.1 12374.3 6467.1 6767.4 6877.1 6996.2 7114.2 5624.8 5641.4 5741.1 5774.7 5958.0 10441.4 10756.6 10792.1 10835.2 10879.8 10583.5 10841.1 10917.5 10924.7 10943.3 7614.8 7736.2 7748.8 7786.3 8139.5 9202.7 9352.3 9438.8 9442.5 9459.0 7442.2 7549.1 7571.7 7605.2 7798.5 7411.5 7419.4 7460.0 7579.7 7588.8 6563.3 6683.0 6762.2 6784.9 6819.5 4733.2 5066.8 5090.0 5154.9 5206.3 4889.2 5019.9 5059.4 5097.8 5099.4 11:25:12 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | [#4] prototype.html Cycles:180 Average:4742.02 Median:5348.57 stddev:1387.26 (25.9%) stddev-sans-first:1351.98 11:25:12 INFO - PID 5089 | Values: 380.9 385.4 390.6 391.0 396.8 5364.9 5416.3 5421.6 5423.9 5457.3 5239.6 5254.6 5297.7 5300.7 5332.3 4190.1 4203.3 4212.1 4214.0 4237.3 4178.3 4206.6 4215.5 4240.4 4247.7 4108.7 4175.9 4204.6 4213.6 4230.2 4171.2 4176.2 4186.8 4190.3 4191.6 3743.7 3752.6 3774.9 3775.9 3777.5 5138.3 5241.2 5261.3 5279.0 5295.5 4889.9 4929.4 4946.2 4952.8 4955.8 5649.0 5658.7 5672.2 5673.5 5713.3 4194.0 4226.2 4247.7 4264.6 4272.8 5778.9 5898.9 5932.9 5939.5 6018.2 3993.3 4053.1 4053.5 4067.3 4076.6 4117.3 4138.4 4139.3 4140.0 4149.0 4699.2 4772.4 4777.1 4792.8 4805.1 5729.4 5739.6 5750.3 5752.8 5767.3 1422.9 1426.4 1427.5 1428.8 1431.9 908.1 948.0 957.2 967.5 968.3 4941.6 4942.1 4943.6 4953.8 4958.5 5892.8 5895.9 5900.7 5913.0 5964.0 4781.2 4863.4 4913.6 4921.7 4935.7 3099.0 3132.3 3133.5 3143.0 3145.5 5438.7 5511.0 5539.2 5554.5 5562.0 6079.6 6093.8 6112.8 6113.9 6117.4 5513.6 5552.1 5560.2 5562.9 5568.0 5704.2 5902.9 5910.3 5944.8 5965.7 5821.9 5839.3 5840.5 5885.2 5932.2 5295.4 5555.6 5562.6 5568.9 5578.7 4088.1 4113.3 4113.4 4119.3 4126.7 5831.9 5997.6 6005.2 6019.4 6023.0 5699.2 5721.8 5763.7 5787.7 5804.6 5752.7 5754.5 5779.6 5787.8 5801.6 5492.3 5666.2 5685.0 5693.9 5703.7 5800.5 5816.7 5822.7 5823.3 5842.6 5424.3 5604.9 5606.5 5611.4 5613.1 11:25:12 INFO - PID 5089 | 11:25:12 INFO - PID 5089 | [#5] yui.html Cycles:180 Average:14859.32 Median:3172.06 stddev:17551.21 (553.3%) stddev-sans-first:17568.38 11:25:12 INFO - PID 5089 | Values: 730.5 746.3 751.5 755.4 787.7 11885.7 12243.9 13388.6 13941.1 13982.5 14084.9 14415.6 14566.0 14591.7 14630.6 813.7 838.1 838.3 840.2 841.4 880.7 885.0 887.3 888.2 888.5 913.2 914.8 916.1 916.7 918.5 900.8 907.5 907.8 908.5 910.0 671.8 672.8 672.9 673.8 674.3 13288.5 13411.3 13424.3 13685.1 13958.9 13506.3 13543.2 13662.6 13764.7 13846.9 11916.4 12056.3 12143.3 12166.5 12197.0 2872.0 2902.8 2922.5 2934.8 2939.4 65675.0 65765.3 66433.7 66897.0 67051.0 10500.8 10511.1 10600.5 10619.5 10738.4 17088.1 17110.1 17115.7 17186.3 17191.5 5702.4 5820.2 5884.6 5887.2 5897.8 2737.2 2779.7 2797.3 2800.3 2814.6 3404.7 3434.3 3447.1 3464.4 3497.9 667.0 672.5 673.2 673.8 675.6 598.3 609.2 616.0 618.8 620.3 9401.3 10211.7 10216.1 10598.6 11030.2 588.0 588.4 596.7 605.0 612.0 4425.1 4539.1 4565.2 4569.3 4569.6 58626.7 61167.0 63203.4 63433.0 63725.4 54087.0 54233.5 54450.2 56167.7 56498.4 44050.6 49604.0 50010.0 50557.0 51693.5 10580.3 10771.3 11178.3 11284.8 11410.4 24103.0 24564.8 25157.1 25781.6 25922.5 40617.0 41011.6 41859.2 42082.4 43211.0 13627.4 13831.8 13882.4 14046.6 14064.9 15305.2 15464.6 15847.7 15853.0 16151.7 14086.8 14229.3 14521.6 14548.3 14594.6 13321.5 13325.9 13467.1 13677.9 13888.8 14210.4 14292.3 14388.6 14451.1 14608.5 9506.7 9566.9 9713.2 10000.1 10076.7 10937.2 11370.8 11483.8 11542.0 11628.3 11:25:12 INFO - PID 5089 | -------- Summary: end -------- 11:25:12 INFO - PID 5089 | 11:25:13 INFO - TEST-INFO | 5089: exit 0 11:25:13 INFO - TEST-OK | dromaeo_css | took 1118760ms 11:25:13 INFO - TEST-START | kraken 11:25:13 INFO - operating with platform_type : linux_ 11:25:13 INFO - Initialising browser for kraken test... 11:25:13 INFO - TEST-INFO | started process 5514 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAWsEBB/profile http://localhost:59872/getInfo.html) 11:25:14 INFO - PID 5514 | JavaScript warning: resource://gre/modules/addons/XPIProvider.jsm, line 2978: String.localeCompare is deprecated; use String.prototype.localeCompare instead 11:25:17 INFO - PID 5514 | __metrics Screen width/height:1600/1200 11:25:17 INFO - PID 5514 | colorDepth:24 11:25:17 INFO - PID 5514 | Browser inner width/height: 1024/695 11:25:17 INFO - PID 5514 | __metrics 11:25:19 INFO - TEST-INFO | 5514: exit 0 11:25:19 INFO - Browser initialized. 11:25:19 INFO - Running cycle 1/1 for kraken test... 11:25:19 INFO - TEST-INFO | started process 5698 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAWsEBB/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:25:31 INFO - PID 5698 | RSS: Main: 170123264 11:25:31 INFO - PID 5698 | 11:25:34 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:59872/tests/kraken/driver.html?testName=audio-beat-detection) 11:25:35 INFO - PID 5698 | RSS: Main: 174170112 11:25:35 INFO - PID 5698 | 11:25:37 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:59872/tests/kraken/driver.html?testName=audio-dft) 11:25:38 INFO - PID 5698 | RSS: Main: 173465600 11:25:38 INFO - PID 5698 | 11:25:41 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:59872/tests/kraken/driver.html?testName=audio-fft) 11:25:42 INFO - PID 5698 | RSS: Main: 168706048 11:25:42 INFO - PID 5698 | 11:25:44 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:59872/tests/kraken/driver.html?testName=audio-oscillator) 11:25:44 INFO - PID 5698 | RSS: Main: 169529344 11:25:44 INFO - PID 5698 | 11:25:46 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:59872/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:25:47 INFO - PID 5698 | RSS: Main: 169689088 11:25:47 INFO - PID 5698 | 11:25:50 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:59872/tests/kraken/driver.html?testName=imaging-darkroom) 11:25:51 INFO - PID 5698 | RSS: Main: 174387200 11:25:51 INFO - PID 5698 | 11:25:54 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:59872/tests/kraken/driver.html?testName=imaging-desaturate) 11:25:55 INFO - PID 5698 | RSS: Main: 171847680 11:25:55 INFO - PID 5698 | 11:25:58 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:59872/tests/kraken/driver.html?testName=json-parse-financial) 11:25:59 INFO - PID 5698 | RSS: Main: 173199360 11:25:59 INFO - PID 5698 | 11:26:00 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:59872/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:26:01 INFO - PID 5698 | RSS: Main: 172736512 11:26:01 INFO - PID 5698 | 11:26:03 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:59872/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:26:03 INFO - PID 5698 | RSS: Main: 172937216 11:26:03 INFO - PID 5698 | 11:26:05 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:59872/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:26:06 INFO - PID 5698 | RSS: Main: 173043712 11:26:06 INFO - PID 5698 | 11:26:09 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:59872/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:26:10 INFO - PID 5698 | RSS: Main: 172756992 11:26:10 INFO - PID 5698 | 11:26:13 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:59872/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:26:13 INFO - PID 5698 | RSS: Main: 172548096 11:26:13 INFO - PID 5698 | 11:26:15 INFO - PID 5698 | Cycle 1(1): loaded http://localhost:59872/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:59872/tests/kraken/driver.html?testName=ai-astar) 11:26:16 INFO - PID 5698 | RSS: Main: 174034944 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | __start_tp_report 11:26:16 INFO - PID 5698 | _x_x_mozilla_page_load 11:26:16 INFO - PID 5698 | _x_x_mozilla_page_load_details 11:26:16 INFO - PID 5698 | |i|pagename|runs| 11:26:16 INFO - PID 5698 | |0;ai-astar;103;115;112;111;112;113;111;111;112;112 11:26:16 INFO - PID 5698 | |1;audio-beat-detection;151;131;129;166;125;125;128;131;159;124 11:26:16 INFO - PID 5698 | |2;audio-dft;163;162;162;163;167;166;163;168;165;163 11:26:16 INFO - PID 5698 | |3;audio-fft;76;75;75;105;76;78;76;79;95;76 11:26:16 INFO - PID 5698 | |4;audio-oscillator;84;84;115;83;84;83;98;83;83;103 11:26:16 INFO - PID 5698 | |5;imaging-gaussian-blur;114;114;114;115;114;118;114;113;118;114 11:26:16 INFO - PID 5698 | |6;imaging-darkroom;150;150;152;151;151;151;150;154;149;150 11:26:16 INFO - PID 5698 | |7;imaging-desaturate;95;96;95;94;96;95;94;94;94;95 11:26:16 INFO - PID 5698 | |8;json-parse-financial;56;61;56;56;56;60;59;57;56;55 11:26:16 INFO - PID 5698 | |9;json-stringify-tinderbox;57;59;60;57;58;57;56;56;57;57 11:26:16 INFO - PID 5698 | |10;stanford-crypto-aes;82;83;92;83;91;81;82;82;84;84 11:26:16 INFO - PID 5698 | |11;stanford-crypto-ccm;142;141;133;144;135;143;134;135;201;142 11:26:16 INFO - PID 5698 | |12;stanford-crypto-pbkdf2;184;193;201;192;196;205;203;193;187;194 11:26:16 INFO - PID 5698 | |13;stanford-crypto-sha256-iterative;77;75;78;81;75;80;74;73;75;76 11:26:16 INFO - PID 5698 | __end_tp_report 11:26:16 INFO - PID 5698 | __start_cc_report 11:26:16 INFO - PID 5698 | _x_x_mozilla_cycle_collect,757 11:26:16 INFO - PID 5698 | __end_cc_report 11:26:16 INFO - PID 5698 | __startTimestamp1495477576045__endTimestamp 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | ------- Summary: start ------- 11:26:16 INFO - PID 5698 | Number of tests: 14 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#0] ai-astar Cycles:10 Average:111.20 Median:112.00 stddev:3.12 (2.8%) stddev-sans-first:1.27 11:26:16 INFO - PID 5698 | Values: 103.0 115.0 112.0 111.0 112.0 113.0 111.0 111.0 112.0 112.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#1] audio-beat-detection Cycles:10 Average:136.90 Median:131.00 stddev:15.62 (11.9%) stddev-sans-first:15.71 11:26:16 INFO - PID 5698 | Values: 151.0 131.0 129.0 166.0 125.0 125.0 128.0 131.0 159.0 124.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#2] audio-dft Cycles:10 Average:164.20 Median:164.00 stddev:2.15 (1.3%) stddev-sans-first:2.24 11:26:16 INFO - PID 5698 | Values: 163.0 162.0 162.0 163.0 167.0 166.0 163.0 168.0 165.0 163.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#3] audio-fft Cycles:10 Average:81.10 Median:76.00 stddev:10.31 (13.6%) stddev-sans-first:10.77 11:26:16 INFO - PID 5698 | Values: 76.0 75.0 75.0 105.0 76.0 78.0 76.0 79.0 95.0 76.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#4] audio-oscillator Cycles:10 Average:90.00 Median:83.50 stddev:11.36 (13.6%) stddev-sans-first:11.84 11:26:16 INFO - PID 5698 | Values: 84.0 84.0 115.0 83.0 84.0 83.0 98.0 83.0 83.0 103.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#5] imaging-gaussian-blur Cycles:10 Average:114.80 Median:114.00 stddev:1.75 (1.5%) stddev-sans-first:1.83 11:26:16 INFO - PID 5698 | Values: 114.0 114.0 114.0 115.0 114.0 118.0 114.0 113.0 118.0 114.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#6] imaging-darkroom Cycles:10 Average:150.80 Median:151.00 stddev:1.40 (0.9%) stddev-sans-first:1.45 11:26:16 INFO - PID 5698 | Values: 150.0 150.0 152.0 151.0 151.0 151.0 150.0 154.0 149.0 150.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#7] imaging-desaturate Cycles:10 Average:94.80 Median:95.00 stddev:0.79 (0.8%) stddev-sans-first:0.83 11:26:16 INFO - PID 5698 | Values: 95.0 96.0 95.0 94.0 96.0 95.0 94.0 94.0 94.0 95.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#8] json-parse-financial Cycles:10 Average:57.20 Median:56.50 stddev:2.04 (3.6%) stddev-sans-first:2.12 11:26:16 INFO - PID 5698 | Values: 56.0 61.0 56.0 56.0 56.0 60.0 59.0 57.0 56.0 55.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#9] json-stringify-tinderbox Cycles:10 Average:57.40 Median:57.00 stddev:1.26 (2.2%) stddev-sans-first:1.33 11:26:16 INFO - PID 5698 | Values: 57.0 59.0 60.0 57.0 58.0 57.0 56.0 56.0 57.0 57.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#10] stanford-crypto-aes Cycles:10 Average:84.40 Median:83.50 stddev:3.86 (4.6%) stddev-sans-first:4.00 11:26:16 INFO - PID 5698 | Values: 82.0 83.0 92.0 83.0 91.0 81.0 82.0 82.0 84.0 84.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#11] stanford-crypto-ccm Cycles:10 Average:145.00 Median:142.00 stddev:20.11 (14.2%) stddev-sans-first:21.30 11:26:16 INFO - PID 5698 | Values: 142.0 141.0 133.0 144.0 135.0 143.0 134.0 135.0 201.0 142.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:194.80 Median:195.00 stddev:6.70 (3.4%) stddev-sans-first:5.85 11:26:16 INFO - PID 5698 | Values: 184.0 193.0 201.0 192.0 196.0 205.0 203.0 193.0 187.0 194.0 11:26:16 INFO - PID 5698 | 11:26:16 INFO - PID 5698 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:76.40 Median:76.50 stddev:2.59 (3.4%) stddev-sans-first:2.74 11:26:16 INFO - PID 5698 | Values: 77.0 75.0 78.0 81.0 75.0 80.0 74.0 73.0 75.0 76.0 11:26:16 INFO - PID 5698 | -------- Summary: end -------- 11:26:16 INFO - PID 5698 | 11:26:17 INFO - TEST-INFO | 5698: exit 0 11:26:17 INFO - TEST-OK | kraken | took 63417ms 11:26:17 INFO - SUITE-END | took 1182s 11:26:17 INFO - Completed test suite (00:19:42) 11:26:17 INFO - javascript benchmark 11:26:17 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6617.909229943217, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2701.8784154713035, 2730.767884729798, 2732.7267273272673, 2761.1026416414657, 2766.170148955313, 5118.9744051279695, 5248.002879452902, 5248.370195576536, 5249.711265880375, 5290.550303224226, 5188.325517682696, 5189.506996835304, 5200.635955483118, 5272.472752724726, 5287.629865909388, 4593.678442509025, 4654.115718013583, 4672.299155126741, 4707.199776038065, 4710.411198600166, 4684.320773487842, 4734.644901632374, 4748.287756836485, 4753.857384278477, 4781.7370044647705, 4595.287730401793, 4620.468646105707, 4634.814607415699, 4664.230401983668, 4679.134360143385, 4673.719576825401, 4677.111348843709, 4681.0, 4707.199776038082, 4724.976375118103, 4576.610988066019, 4635.768211589407, 4640.67515273931, 4658.58072773452, 4664.113818374498, 5030.698158110525, 5150.871228219287, 5202.557782588485, 5205.219217117425, 5244.842654720364, 5590.91613625796, 5603.439656034405, 5658.321001479808, 5659.830205093854, 5661.094224924033, 5534.972325138348, 5558.888822223574, 5559.138333558305, 5562.471565201299, 5565.3599836018975, 5155.484451554815, 5169.974150129226, 5187.351581052369, 5196.818111366122, 5220.530152286313, 5723.198752174699, 5725.227094342211, 5735.684537350486, 5744.224529688522, 5746.0, 5475.4524547544925, 5484.890302193934, 5546.750396232179, 5562.082256427644, 5562.276904002454, 5616.971915140398, 5642.689652069093, 5643.266375371258, 5653.745581448845, 5702.657840529581, 5469.972650136724, 5578.97210513953, 5587.636803607753, 5588.6646801192055, 5596.2165296858475, 5454.4545545445135, 5536.557075433956, 5591.832245032656, 5594.748236329375, 5657.12314591239, 4575.22221222393, 4585.899384147847, 4646.83736069236, 4647.024124933734, 4653.557911998355, 3986.6412022918075, 3993.4608827808456, 4010.5187377514885, 4026.63760261572, 4054.2904991626347, 4636.884077898079, 4694.788734506956, 4702.717836929795, 4712.151812673752, 4719.10337035962, 5486.890262194734, 5505.752241149158, 5585.134304182858, 5595.281902356036, 5602.0, 4741.739204343725, 4756.405449318835, 4760.262159365304, 4760.785764640599, 4768.904621907543, 4917.704937703749, 4938.111139994836, 4962.975185124052, 5019.196928491424, 5022.4977502249485, 5207.817726379559, 5215.165573508372, 5254.15933450646, 5271.393789714155, 5314.7874085036165, 5483.698396588226, 5513.862153446196, 5599.664020158803, 5655.519280861008, 5659.801906933238, 5196.584273258206, 5231.659942103751, 5235.528802407802, 5282.603804714585, 5292.41783403833, 5432.212329212163, 5490.0, 5504.834854954358, 5534.142207957773, 5553.4724201200825, 5540.1135818270495, 5615.241942337732, 5654.802081927113, 5664.631798933056, 5683.318001839806, 5342.3856256531, 5430.891382172255, 5442.673439593637, 5457.945420545744, 5481.945180548303, 5386.730663466733, 5391.568674506108, 5394.703291319015, 5398.082326004667, 5404.108322126962, 5284.471552844685, 5292.5501332387175, 5305.628605997543, 5317.468253174651, 5322.121849894879, 5328.040952628564, 5399.70301633414, 5415.539679127318, 5417.322834645669, 5419.0245755764345, 5257.447967963309, 5274.841754747364, 5286.841394758163, 5290.65610735301, 5323.0950738373795], "value": 5073.384274555467, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [591.7514643849582, 649.1690635985938, 663.7013343995201, 1164.0920082335776, 1176.5411489519083, 33310.33379332412, 34341.0, 34367.31265374691, 34397.48403773939, 34482.137946551346, 32549.186270343253, 33053.504197437054, 33085.33829323412, 33142.68001239914, 33155.834220828925, 6455.967720161404, 6800.183977922657, 6982.092327997353, 6983.790486285419, 6995.79012629622, 6876.449884009267, 6990.790276291719, 6993.580385176881, 6998.195207551121, 7000.754973575926, 6956.060931774222, 7017.403520700746, 7024.332688394595, 7031.050808140887, 7038.120234970629, 6924.653767311639, 6953.130858642669, 6954.165500140016, 6959.1996920353795, 6981.197162326347, 6920.5847649141215, 6976.302369763034, 6978.197507286676, 6997.895031574531, 7003.15962084548, 31545.21136971571, 31560.526592101138, 31828.522572161437, 31839.0, 31901.52147717786, 3097.6902309769066, 3116.1274843043984, 3123.7344825689843, 3129.85915633797, 3131.2171957010746, 24243.636345454834, 24287.0, 24423.63364549533, 24446.26661200167, 24479.143229986865, 2968.7328140467243, 2993.790434669574, 3024.2892920163745, 3051.6338039435186, 3084.981955954552, 147153.0, 147310.0, 147606.26196869055, 159061.0, 163493.18253408777, 37677.81161094177, 38234.0, 38316.0, 38317.23365532674, 38357.424638630444, 40412.393814092815, 40428.0, 40497.392539111934, 42142.57857421448, 43060.56939430628, 10768.892311076946, 10815.351078935131, 10948.890511094947, 11000.834987475195, 11003.33979961189, 7994.5602991836, 8008.679652813938, 8012.399070069651, 8062.0, 8100.878486822702, 12416.503339866304, 12441.066919981038, 12478.81281780774, 12487.562935297221, 12741.362931853555, 5187.403448603459, 5271.128749294022, 5333.706646134422, 5368.8389348319615, 5437.510624043776, 872.8996165440929, 880.9735707928644, 896.3980285199589, 909.7907481279343, 936.091990768953, 20484.078216479997, 21224.469388265417, 21483.78516214849, 21583.56832863334, 21719.67420488694, 962.7593101724569, 968.4431451915177, 990.2276224544867, 991.7371896447447, 998.1515711645044, 10958.890411095947, 11074.889251107386, 11134.888651113386, 11287.0, 11374.658760237206, 157737.21131394498, 163221.0, 163595.0, 164028.0, 185800.0, 42062.0, 42605.36091958623, 42832.78583607062, 43127.137457250676, 43238.0, 1200.4897918384652, 1216.6836622478043, 1224.063591352616, 1226.6749311432657, 1228.784962631536, 24221.394465138514, 24278.878605607566, 24783.50432991366, 25379.74620253774, 25433.745662543137, 29502.852485737432, 35819.0, 36516.0, 36578.26843463169, 36609.45085823662, 160859.19570402073, 162308.0, 162395.0, 162428.0, 162644.18677906535, 29265.85367073151, 29270.70729292765, 29290.267743306587, 29573.408531828813, 29664.703352966193, 34191.4871276936, 34758.30483390368, 35467.64532354747, 35595.0, 35785.1053723659, 26193.4761304769, 26388.736112638628, 27174.29339838577, 27676.584851226846, 27825.860870695516, 26368.8681556591, 26447.471050579265, 26644.866775666775, 27777.166684999484, 27850.582241266802, 29068.0, 29418.264543386587, 29714.405711886073, 29833.403331933674, 30035.849820750755, 26227.868860656337, 26518.469630607666, 26629.334266643487, 26858.865705671345, 27605.171844844688, 21301.57396852023, 22145.778542215015, 22189.778102219418, 22274.549799522363, 22373.552528949655], "value": 14433.098783772703, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [395.3200495148344, 396.5281315234872, 415.0640306109721, 424.2977871622465, 426.976516291604, 16725.163741812907, 17399.0, 17428.651426971453, 17493.562660933483, 18230.0884955752, 17151.313947442086, 17252.82747172528, 17373.30506779727, 17917.820821791778, 18027.639447211048, 5210.869728256805, 5223.294855194547, 5315.229291752694, 5416.350037995427, 5428.782848686048, 5232.45059268777, 5346.759395827197, 5356.892862142755, 5377.623566350357, 5381.973090134544, 5179.171332586787, 5232.659877107976, 5280.0, 5305.761240744157, 5355.384130824966, 5365.356157261134, 5411.83764487066, 5415.13357862744, 5430.5384042356645, 5437.0, 4680.789364478606, 4839.322494850724, 4882.707037577757, 4895.755212239374, 4910.877228069291, 21389.144434222613, 21433.78566214349, 21516.89241553798, 21697.0, 21899.124035038578, 1606.9598260043476, 1633.2405431474303, 1636.443609172887, 1641.0973964319696, 1644.1779110444777, 14311.141331520039, 15197.164155971417, 15234.390624375012, 15324.923375383052, 15344.616384590363, 1986.8708533945392, 2062.9071691773756, 2096.5702031083592, 2106.6208082545136, 2115.809577138065, 75755.24244757537, 76453.85319220216, 77356.22643773603, 77662.22337776606, 78461.21538784596, 10292.536835842406, 10440.634577789893, 10569.682909512727, 10633.308834925705, 10686.732831679115, 13942.58172254834, 13956.930215348859, 14021.088629239272, 14035.929820350833, 14054.508092216927, 6410.1987251593555, 6568.343165683489, 6575.276719560845, 6737.157855268091, 6752.527323087336, 5813.0, 5830.912536311958, 6006.489448396936, 6009.759609615567, 6040.879182416327, 6626.53614246998, 6784.151981002375, 6807.0, 6811.761588344483, 6987.930120698829, 2015.2241387065792, 2016.385002574229, 2025.3822584111988, 2038.7043878637514, 2049.2008116834445, 874.3879284500874, 899.6761165980242, 904.7059705595576, 910.6676063236871, 929.8605209218535, 17195.0, 17220.311187552357, 17990.280388784562, 18037.0, 18166.455006349832, 887.1616322575234, 895.4716717136921, 900.2123142250531, 909.7725568607848, 931.9301052421096, 9379.577918993662, 9411.6705915294, 9780.755481112887, 9806.16075152426, 9928.652497162564, 344611.0, 346019.0, 348357.0, 354859.0, 357584.0, 74617.62691186617, 81190.0, 82652.0, 83037.58481207555, 83609.58195208985, 1059.6185373265619, 1059.6397224943403, 1103.9779204415868, 1111.5442668506034, 1121.46730303107, 17535.736963945295, 17657.823421765617, 18247.178876950835, 18311.816881831543, 18538.443846684622, 39585.406218907316, 40030.11807882555, 40339.596604034756, 41485.37771933363, 41751.373729393476, 51347.48652513427, 51769.741151294, 52355.0, 53784.46215537794, 54089.0, 11904.226225295328, 12114.454849531616, 12191.0, 12333.814992775295, 12444.128910976146, 12824.0, 13037.817452597206, 13111.60665180046, 13528.797068044185, 13549.322533873465, 11142.498587563741, 11421.486033128363, 11486.253393529394, 11588.072954163477, 11863.390054188065, 10484.26610137283, 10904.236703430684, 10959.342439453658, 10991.945040274748, 11026.173037022096, 11400.429978501208, 11416.086713063101, 11421.31472111676, 11442.885571144516, 11734.765304694029, 11916.404179790803, 12037.879621203676, 12084.39578021113, 12214.328211948428, 12471.189372690746, 11107.555697771999, 11163.330200188015, 11295.548178072784, 11598.652040438801, 11639.6508104757], "value": 8945.038242545883, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1245.3399698159976, 1304.165334186121, 1304.3478260869567, 1307.3267267357307, 1322.623052430057, 9493.810123797528, 9835.901640983588, 9869.062439068277, 9936.55285512152, 10007.599696012168, 9773.462459564722, 9895.109440150385, 9942.0, 9958.751031224205, 9985.101340879319, 2228.1533017453344, 2248.57277117348, 2257.7516473187934, 2268.750437451879, 2271.659251112338, 2168.8590241634324, 2212.2920665387082, 2217.3791338425267, 2223.032980653421, 2224.065892325219, 2164.7618761936255, 2175.749788774295, 2208.094681180716, 2214.2914267434426, 2214.900329485177, 2165.5127596290868, 2181.9345419637434, 2201.9559608807813, 2206.470447092694, 2208.1940091866513, 2039.7042428847883, 2176.967345489819, 2188.190369563256, 2195.484061245606, 2205.3935167828813, 9086.091390860927, 9195.586198621011, 9215.493147876865, 9238.491882946435, 9251.0, 5173.715445650488, 5348.946510534923, 5376.489233522809, 5390.595705322077, 5435.266239057716, 3154.2429816844024, 3245.5293982372423, 3286.6549012353835, 3323.567936168283, 3400.387930172568, 1082.8050950828847, 1084.5770149641646, 1121.899029087386, 1131.5473810475794, 1142.5715356741223, 13871.306434678225, 13938.0, 13945.721085578332, 13959.511417100353, 14028.228447435387, 4379.299312110111, 4635.351050852883, 4677.6959497633225, 4693.6949098308505, 4755.785989630475, 10033.749156271006, 10062.496875156214, 10129.898701013042, 10130.24023198263, 10131.290809643255, 5266.92099618506, 5303.708296043677, 5311.309529761106, 5321.32378300834, 5330.733463326896, 4686.507916668701, 4938.407391113089, 4951.480094590088, 4986.476419975923, 5025.3718285214345, 3591.28174365128, 3690.634465247822, 3705.4256590228556, 3752.681022113151, 3772.2078363543415, 1034.9793004139874, 1041.6250149946013, 1043.4678314059884, 1046.1892033673812, 1055.9260851740305, 689.1076056506836, 708.479267738212, 710.733474946895, 726.7129483853848, 729.1978823294334, 5020.748962551931, 5133.640645154878, 5156.587473002151, 5221.190715439113, 5267.604929630293, 542.552394274725, 553.3221803291017, 553.3885057011944, 553.6456667732655, 554.7780887644893, 3333.9166520837175, 3383.8308084595674, 3496.0, 3554.377983852867, 3631.94552081719, 11888.227265227733, 12324.0, 12338.50645974169, 12405.255684658949, 12506.0, 12309.26144431337, 12328.81506777399, 12357.691057723448, 12359.073069519822, 12374.257544547356, 6467.126937863422, 6767.35710107539, 6877.071595334766, 6996.195437524648, 7114.181869085121, 5624.775008999594, 5641.379448260606, 5741.110127930177, 5774.682392468455, 5958.0, 10441.425721585385, 10756.569737210424, 10792.136629069499, 10835.187360947803, 10879.836802447811, 10583.523741431809, 10841.132709383073, 10917.454127293444, 10924.726881828017, 10943.28868623537, 7614.847703046019, 7736.1877002916135, 7748.806279843049, 7786.299233069051, 8139.511629302261, 9202.677906273248, 9352.298577606844, 9438.764030899283, 9442.52787360643, 9459.0, 7442.181360050498, 7549.0941087069905, 7571.659275332733, 7605.23947605235, 7798.493097948615, 7411.4811963162065, 7419.369353605004, 7460.0, 7579.734709285149, 7588.8482230353975, 6563.278039415565, 6682.966585167237, 6762.188537375547, 6784.93215067843, 6819.4544436443975, 4733.219018861849, 5066.797328106834, 5090.0, 5154.948450515447, 5206.349206349207, 4889.217725163957, 5019.874503137451, 5059.443461219336, 5097.8215762448135, 5099.388073431212], "value": 4476.365360558224, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [380.9009657489052, 385.4083981089029, 390.6308538431183, 390.99022524436884, 396.8432469174678, 5364.865878353038, 5416.322959630046, 5421.593380496463, 5423.945760542393, 5457.345118585766, 5239.633225674204, 5254.57963362931, 5297.728545149165, 5300.655457395266, 5332.280142180814, 4190.120074784284, 4203.327467605184, 4212.115455754295, 4213.9578604213875, 4237.258479766044, 4178.331466965286, 4206.621404073633, 4215.473065866767, 4240.3851441540955, 4247.723897946639, 4108.712390132692, 4175.937360939588, 4204.600562946515, 4213.641840443551, 4230.19626271009, 4171.20747058061, 4176.220520429017, 4186.769727664977, 4190.28765109929, 4191.580841915815, 3743.6630703236838, 3752.6247375262255, 3774.9049277650893, 3775.924481510382, 3777.471154038437, 5138.332016837825, 5241.187615919539, 5261.263423120766, 5278.973605131988, 5295.4704529547125, 4889.8777530561665, 4929.383827021622, 4946.159152944008, 4952.801887924515, 4955.82654607087, 5649.0114230009585, 5658.6516595612775, 5672.177534257509, 5673.546116310686, 5713.257276554022, 4193.979030104861, 4226.239276930151, 4247.681423893189, 4264.637505812009, 4272.786360681985, 5778.942210577882, 5898.852528686774, 5932.851678708023, 5939.46544810969, 6018.15745795589, 3993.341098718737, 4053.128577355824, 4053.493313335833, 4067.3085575452246, 4076.5719599442223, 4117.341225403981, 4138.420621113047, 4139.275626765304, 4140.047789008545, 4148.958510414917, 4699.224627936421, 4772.4228916385455, 4777.092352453023, 4792.760361981887, 4805.111054454937, 5729.393126127602, 5739.569532285095, 5750.281214848144, 5752.769889204469, 5767.307923049261, 1422.907511011781, 1426.3866537388815, 1427.4932398998415, 1428.8213973253344, 1431.8616699723746, 908.1372695938885, 947.9715608531756, 957.1816097236763, 967.5355829202023, 968.3173362779223, 4941.629377796679, 4942.110420124341, 4943.604511639061, 4953.7523123844385, 4958.504149585013, 5892.7642894283745, 5895.882082358415, 5900.734466948998, 5912.970435147797, 5963.970180149158, 4781.163296423112, 4863.416390033219, 4913.631477639191, 4921.680090794159, 4935.703857768545, 3099.024936061361, 3132.263917979273, 3133.5299705044426, 3142.98428507856, 3145.496720524751, 5438.6736795791585, 5510.980468613319, 5539.169124631338, 5554.50009499147, 5562.0, 6079.574429789961, 6093.817185484442, 6112.847178820476, 6113.908291375544, 6117.449429551361, 5513.61404701667, 5552.139418390156, 5560.165975103767, 5562.888742225214, 5568.0, 5704.201411802268, 5902.911456328073, 5910.290765108214, 5944.791932282349, 5965.73154208053, 5821.912671309849, 5839.328477225174, 5840.474357307863, 5885.205497257986, 5932.199153114447, 5295.417504074626, 5555.638883472561, 5562.5549956002615, 5568.860778480571, 5578.748956297058, 4088.0801819590356, 4113.341865301538, 4113.4035564843525, 4119.340905455113, 4126.690498212586, 5831.94168058314, 5997.610155339889, 6005.219321488178, 6019.428154325507, 6022.969885150546, 5699.230603868425, 5721.799737009184, 5763.740631671669, 5787.681677507778, 5804.593678442468, 5752.741126649395, 5754.468034064998, 5779.566532510163, 5787.826365209051, 5801.622894511843, 5492.286002819608, 5666.2350582670815, 5684.953416769877, 5693.943060569507, 5703.686297253691, 5800.477956983892, 5816.680082595329, 5822.679752613647, 5823.272090988627, 5842.620229685057, 5424.321959755031, 5604.9084168556365, 5606.542299002371, 5611.354694210055, 5613.129964855454], "value": 4313.414151218659, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [730.4850080693112, 746.2798399544439, 751.5340488896885, 755.3503986571549, 787.7321710618388, 11885.702857428569, 12243.877561224384, 13388.598342049741, 13941.093828901114, 13982.510612128564, 14084.92957535211, 14415.63960900978, 14566.0, 14591.708165836704, 14630.634234144152, 813.662330132994, 838.0739283092187, 838.329336530776, 840.2395831772226, 841.4194205997873, 880.7093659092484, 884.9513276769775, 887.3078998381272, 888.1873086126219, 888.4979986307748, 913.2009491694768, 914.8216097860919, 916.097643820836, 916.6562539047857, 918.4626993208981, 900.7973206028656, 907.5326207003366, 907.8048219632777, 908.500324821349, 909.9772505687345, 671.8488340123482, 672.831792051987, 672.862063277027, 673.7709178879155, 674.2953613473883, 13288.534901278408, 13411.329433528284, 13424.32878356088, 13685.11046781956, 13958.930205348908, 13506.32468376587, 13543.187408755506, 13662.590122296348, 13764.724705505834, 13846.93076534621, 11916.404179791063, 12056.336901470415, 12143.271403715717, 12166.452509637087, 12197.0, 2871.956920646192, 2902.840343781091, 2922.503174460347, 2934.823910565373, 2939.382729626781, 65675.0, 65765.34234657687, 66433.66783166054, 66897.0, 67051.0, 10500.842487362695, 10511.106555942677, 10600.469976501145, 10619.469026548642, 10738.355698658106, 17088.145592720313, 17110.14449277531, 17115.74326385105, 17186.31254749821, 17191.484255472355, 5702.372738998707, 5820.214271073351, 5884.58807883444, 5887.2052272943465, 5897.7935772247765, 2737.178846346088, 2779.680336761258, 2797.342624483245, 2800.327921298914, 2814.620026296465, 3404.744644151649, 3434.3131373725355, 3447.0692912913373, 3464.4456886897974, 3497.877574284888, 666.9699863506154, 672.5225090185925, 673.1787219592089, 673.7978606418055, 675.6385333846368, 598.3149294058279, 609.2262826210688, 615.9928516874852, 618.8236352639476, 620.2804746494136, 9401.294902882311, 10211.693649190536, 10216.131628811485, 10598.576056957789, 11030.22788404804, 588.0297509110003, 588.3704436253169, 596.6569222696967, 605.0349692240869, 612.0, 4425.114977004612, 4539.137563862855, 4565.246734288871, 4569.268916973335, 4569.634429245652, 58626.70686646625, 61167.0, 63203.36796631975, 63432.97386748251, 63725.36274637287, 54087.0, 54233.457665422844, 54450.18324725132, 56167.71916140393, 56498.43501565014, 44050.55949440529, 49604.0, 50010.0, 50557.0, 51693.48306516962, 10580.259381843198, 10771.29986550903, 11178.329300242012, 11284.830727539258, 11410.372429516125, 24103.0, 24564.754352456246, 25157.11950081738, 25781.613275800504, 25922.481550369263, 40617.0, 41011.58988410078, 41859.1628167441, 42082.368764467945, 43211.0, 13627.38676759568, 13831.792523112363, 13882.375293111632, 14046.578602641937, 14064.929675351557, 15305.158216297765, 15464.613384665023, 15847.683046338778, 15853.048817071012, 16151.67696646084, 14086.788698169741, 14229.288535573387, 14521.636959075686, 14548.345324460637, 14594.635134121732, 13321.467141314239, 13325.933370333087, 13467.057305988486, 13677.931610341884, 13888.791668125188, 14210.360533775798, 14292.28538573088, 14388.640283992983, 14451.132932024113, 14608.488702895347, 9506.662942866284, 9566.877198593045, 9713.174380177481, 10000.149987251165, 10076.748081298027, 10937.179711521509, 11370.772584548427, 11483.827742584035, 11542.0, 11628.302301861915], "value": 6642.094173655516, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1559.0000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 115.0, 112.0, 111.0, 112.0, 113.0, 111.0, 111.0, 112.0, 112.0], "value": 111.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 131.0, 129.0, 166.0, 125.0, 125.0, 128.0, 131.0, 159.0, 124.0], "value": 136.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 162.0, 163.0, 167.0, 166.0, 163.0, 168.0, 165.0, 163.0], "value": 164.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 75.0, 105.0, 76.0, 78.0, 76.0, 79.0, 95.0, 76.0], "value": 81.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 115.0, 83.0, 84.0, 83.0, 98.0, 83.0, 83.0, 103.0], "value": 90.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 114.0, 115.0, 114.0, 118.0, 114.0, 113.0, 118.0, 114.0], "value": 114.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 150.0, 152.0, 151.0, 151.0, 151.0, 150.0, 154.0, 149.0, 150.0], "value": 150.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 95.0, 94.0, 96.0, 95.0, 94.0, 94.0, 94.0, 95.0], "value": 94.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 61.0, 56.0, 56.0, 56.0, 60.0, 59.0, 57.0, 56.0, 55.0], "value": 57.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 59.0, 60.0, 57.0, 58.0, 57.0, 56.0, 56.0, 57.0, 57.0], "value": 57.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 83.0, 92.0, 83.0, 91.0, 81.0, 82.0, 82.0, 84.0, 84.0], "value": 84.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 141.0, 133.0, 144.0, 135.0, 143.0, 134.0, 135.0, 201.0, 142.0], "value": 145.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [184.0, 193.0, 201.0, 192.0, 196.0, 205.0, 203.0, 193.0, 187.0, 194.0], "value": 194.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 75.0, 78.0, 81.0, 75.0, 80.0, 74.0, 73.0, 75.0, 76.0], "value": 76.4, "unit": "score"}]}]} 11:26:17 INFO - Return code: 0 11:26:17 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:26:17 INFO - # TBPL SUCCESS # 11:26:17 INFO - Running post-action listener: _resource_record_post_action 11:26:17 INFO - [mozharness: 2017-05-22 18:26:17.330646Z] Finished run-tests step (success) 11:26:17 INFO - Running post-run listener: _resource_record_post_run 11:26:17 INFO - Total resource usage - Wall time: 1199s; CPU: 13.0%; Read bytes: 466944; Write bytes: 409825280; Read time: 288; Write time: 204132 11:26:17 INFO - TinderboxPrint: CPU usage
13.3% 11:26:17 INFO - TinderboxPrint: I/O read bytes / time
466,944 / 288 11:26:17 INFO - TinderboxPrint: I/O write bytes / time
409,825,280 / 204,132 11:26:17 INFO - TinderboxPrint: CPU idle
8,293.5 (86.7%) 11:26:17 INFO - TinderboxPrint: CPU user
1,217.9 (12.7%) 11:26:17 INFO - TinderboxPrint: Swap in / out
0 / 0 11:26:17 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 95408128; Read time: 0; Write time: 86928 11:26:17 INFO - run-tests - Wall time: 1183s; CPU: 13.0%; Read bytes: 466944; Write bytes: 313876480; Read time: 288; Write time: 117176 11:26:17 INFO - Running post-run listener: _upload_blobber_files 11:26:17 INFO - Blob upload gear active. 11:26:17 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:26: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:26: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', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:26: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 Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:26:18 INFO - (blobuploader) - INFO - Open directory for files ... 11:26:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 11:26:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:26:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:26:19 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 11:26:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:26:19 INFO - (blobuploader) - INFO - Done attempting. 11:26:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 11:26:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:26:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:26:20 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 11:26:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:26:20 INFO - (blobuploader) - INFO - Done attempting. 11:26:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:26:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:26:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:26:28 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:26:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:26:28 INFO - (blobuploader) - INFO - Done attempting. 11:26:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 11:26:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:26:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:26:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 11:26:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:26:29 INFO - (blobuploader) - INFO - Done attempting. 11:26:29 INFO - (blobuploader) - INFO - Iteration through files over. 11:26:29 INFO - Return code: 0 11:26:29 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:26:29 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:26:29 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/879409795f31fa8214085c0d6c3a65f54c71b739f38ef26b67f0df9bbd7ce521da04bfe5e9f697065b317227f5db00fc7e90578437e06eb690decfac2413b424", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f5399909a2d6ff9015d270d18f777fbfe8d4a3224e5fd8b366fab510075d2139ae0160526d5be8c5c3e2c7ff2c28ae8bac39fb049b35dfd396ecace7a350f05b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b68edbe4d8d142c64fbc94df9ed76fa698c55124004fb1bcd316bd24f8dff040dfc1536bff7257ba8de91c9e9c149092fc864d07639300bcde888e932cd88eec", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d01858c7520c8125eaaeb34536c58a9ec872684b164c9849a489f66be02065e6ea3e868c7a7c8b439034f5815f2cdad6e5e39124ef48230901875e45a1058893"} 11:26:29 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:26:29 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:26:29 INFO - Contents: 11:26:29 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/879409795f31fa8214085c0d6c3a65f54c71b739f38ef26b67f0df9bbd7ce521da04bfe5e9f697065b317227f5db00fc7e90578437e06eb690decfac2413b424", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f5399909a2d6ff9015d270d18f777fbfe8d4a3224e5fd8b366fab510075d2139ae0160526d5be8c5c3e2c7ff2c28ae8bac39fb049b35dfd396ecace7a350f05b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b68edbe4d8d142c64fbc94df9ed76fa698c55124004fb1bcd316bd24f8dff040dfc1536bff7257ba8de91c9e9c149092fc864d07639300bcde888e932cd88eec", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d01858c7520c8125eaaeb34536c58a9ec872684b164c9849a489f66be02065e6ea3e868c7a7c8b439034f5815f2cdad6e5e39124ef48230901875e45a1058893"} 11:26:29 INFO - Running post-run listener: copy_logs_to_upload_dir 11:26:29 INFO - Copying logs to upload dir... 11:26:29 INFO - mkdir: /builds/slave/test/build/upload/logs 11:26:29 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1261.651699 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2017-05-22 11:26:29.795144) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-22 11:26:29.798820) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/879409795f31fa8214085c0d6c3a65f54c71b739f38ef26b67f0df9bbd7ce521da04bfe5e9f697065b317227f5db00fc7e90578437e06eb690decfac2413b424", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f5399909a2d6ff9015d270d18f777fbfe8d4a3224e5fd8b366fab510075d2139ae0160526d5be8c5c3e2c7ff2c28ae8bac39fb049b35dfd396ecace7a350f05b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b68edbe4d8d142c64fbc94df9ed76fa698c55124004fb1bcd316bd24f8dff040dfc1536bff7257ba8de91c9e9c149092fc864d07639300bcde888e932cd88eec", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d01858c7520c8125eaaeb34536c58a9ec872684b164c9849a489f66be02065e6ea3e868c7a7c8b439034f5815f2cdad6e5e39124ef48230901875e45a1058893"} build_url:https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011237 build_url: 'https://queue.taskcluster.net/v1/task/EC69cXx2Tm6yTBE0GLEc_g/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/879409795f31fa8214085c0d6c3a65f54c71b739f38ef26b67f0df9bbd7ce521da04bfe5e9f697065b317227f5db00fc7e90578437e06eb690decfac2413b424", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f5399909a2d6ff9015d270d18f777fbfe8d4a3224e5fd8b366fab510075d2139ae0160526d5be8c5c3e2c7ff2c28ae8bac39fb049b35dfd396ecace7a350f05b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b68edbe4d8d142c64fbc94df9ed76fa698c55124004fb1bcd316bd24f8dff040dfc1536bff7257ba8de91c9e9c149092fc864d07639300bcde888e932cd88eec", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d01858c7520c8125eaaeb34536c58a9ec872684b164c9849a489f66be02065e6ea3e868c7a7c8b439034f5815f2cdad6e5e39124ef48230901875e45a1058893"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-22 11:26:29.823086) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 11:26:29.823423) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1495476041.105676-1691173754 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004420 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 11:26:29.909292) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-22 11:26:29.909613) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-22 11:26:29.909901) ========= ========= Total master_lag: 0.16 =========